Running: ./testmodel.py --libraries=/home/hudson/saved_omc/libraries/.openmodelica/libraries/ --ompython_omhome=/usr AixLib_latest_AixLib.Systems.ModularAHU.Examples.DemandControlledAHU.conf.json loadFile("/home/hudson/saved_omc/libraries/.openmodelica/libraries/ModelicaServices 4.0.0+maint.om/package.mo", uses=false) loadFile("/home/hudson/saved_omc/libraries/.openmodelica/libraries/Complex 4.0.0+maint.om/package.mo", uses=false) loadFile("/home/hudson/saved_omc/libraries/.openmodelica/libraries/Modelica 4.0.0+maint.om/package.mo", uses=false) loadFile("/home/hudson/saved_omc/libraries/.openmodelica/libraries/Modelica_DeviceDrivers 2.1.1/package.mo", uses=false) loadFile("/home/hudson/saved_omc/libraries/.openmodelica/libraries/SDF master/package.mo", uses=false) loadFile("/home/hudson/saved_omc/libraries/.openmodelica/libraries/AixLib 1.4.0-development/package.mo", uses=false) Using package AixLib with version 1.4.0 (/home/hudson/saved_omc/libraries/.openmodelica/libraries/AixLib 1.4.0-development/package.mo) Using package SDF with version 0.0.0 (/home/hudson/saved_omc/libraries/.openmodelica/libraries/SDF master/package.mo) Using package Modelica_DeviceDrivers with version 2.1.1 (/home/hudson/saved_omc/libraries/.openmodelica/libraries/Modelica_DeviceDrivers 2.1.1/package.mo) Using package Modelica with version 4.0.0 (/home/hudson/saved_omc/libraries/.openmodelica/libraries/Modelica 4.0.0+maint.om/package.mo) Using package Complex with version 4.0.0 (/home/hudson/saved_omc/libraries/.openmodelica/libraries/Complex 4.0.0+maint.om/package.mo) Using package ModelicaServices with version 4.0.0 (/home/hudson/saved_omc/libraries/.openmodelica/libraries/ModelicaServices 4.0.0+maint.om/package.mo) Running command: translateModel(AixLib.Systems.ModularAHU.Examples.DemandControlledAHU,tolerance=1e-05,outputFormat="empty",numberOfIntervals=10078,variableFilter="",fileNamePrefix="AixLib_latest_AixLib.Systems.ModularAHU.Examples.DemandControlledAHU") translateModel(AixLib.Systems.ModularAHU.Examples.DemandControlledAHU,tolerance=1e-05,outputFormat="empty",numberOfIntervals=10078,variableFilter="",fileNamePrefix="AixLib_latest_AixLib.Systems.ModularAHU.Examples.DemandControlledAHU") Notification: Performance of loadFile(/home/hudson/saved_omc/libraries/.openmodelica/libraries/ModelicaServices 4.0.0+maint.om/package.mo): time 0.0008239/0.0008242, allocations: 91.84 kB / 15.36 MB, free: 0.7383 MB / 14.72 MB Notification: Performance of loadFile(/home/hudson/saved_omc/libraries/.openmodelica/libraries/Complex 4.0.0+maint.om/package.mo): time 0.004778/0.004778, allocations: 173.8 kB / 16.27 MB, free: 6.676 MB / 14.72 MB Notification: Performance of loadFile(/home/hudson/saved_omc/libraries/.openmodelica/libraries/Modelica 4.0.0+maint.om/package.mo): time 1.317/1.317, allocations: 223.2 MB / 240.3 MB, free: 5.348 MB / 190.1 MB Notification: Performance of loadFile(/home/hudson/saved_omc/libraries/.openmodelica/libraries/Modelica_DeviceDrivers 2.1.1/package.mo): time 0.1723/0.1723, allocations: 12.03 MB / 303.5 MB, free: 1.719 MB / 238.1 MB Notification: Performance of loadFile(/home/hudson/saved_omc/libraries/.openmodelica/libraries/SDF master/package.mo): time 0.0002459/0.0002457, allocations: 19.92 kB / 357.6 MB, free: 3.082 MB / 286.1 MB [/home/hudson/saved_omc/libraries/.openmodelica/libraries/AixLib 1.4.0-development/Obsolete/YearIndependent/FastHVAC/Components/HeatExchangers/RadiatorMultiLayer.mo:265:34-265:6228:writable] Warning: Lexer treating \ as \\, since \ is not a valid Modelica escape sequence. [/home/hudson/saved_omc/libraries/.openmodelica/libraries/AixLib 1.4.0-development/Obsolete/YearIndependent/FastHVAC/Components/HeatExchangers/RadiatorMultiLayer.mo:265:34-265:6853:writable] Warning: Lexer treating \ as \\, since \ is not a valid Modelica escape sequence. [/home/hudson/saved_omc/libraries/.openmodelica/libraries/AixLib 1.4.0-development/Obsolete/YearIndependent/FastHVAC/Components/HeatExchangers/RadiatorMultiLayer.mo:265:34-265:8435:writable] Warning: Lexer treating \ as \\, since \ is not a valid Modelica escape sequence. [/home/hudson/saved_omc/libraries/.openmodelica/libraries/AixLib 1.4.0-development/Obsolete/YearIndependent/FastHVAC/Components/HeatExchangers/RadiatorMultiLayer.mo:265:34-265:9369:writable] Warning: Lexer treating \ as \\, since \ is not a valid Modelica escape sequence. [/home/hudson/saved_omc/libraries/.openmodelica/libraries/AixLib 1.4.0-development/Obsolete/YearIndependent/FastHVAC/Components/HeatExchangers/RadiatorMultiLayer.mo:265:34-265:11505:writable] Warning: Lexer treating \ as \\, since \ is not a valid Modelica escape sequence. [/home/hudson/saved_omc/libraries/.openmodelica/libraries/AixLib 1.4.0-development/Obsolete/YearIndependent/FastHVAC/Components/HeatExchangers/RadiatorMultiLayer.mo:265:34-265:12875:writable] Warning: Lexer treating \ as \\, since \ is not a valid Modelica escape sequence. [/home/hudson/saved_omc/libraries/.openmodelica/libraries/AixLib 1.4.0-development/ThermalZones/HighOrder/Components/Examples/DryAir/DryAir_test.mo:71:18-71:405:writable] Warning: Lexer treating \ as \\, since \ is not a valid Modelica escape sequence. [/home/hudson/saved_omc/libraries/.openmodelica/libraries/AixLib 1.4.0-development/ThermalZones/HighOrder/Components/DryAir/InfiltrationRate_DIN12831.mo:20:192-20:2066:writable] Warning: Lexer treating \ as \\, since \ is not a valid Modelica escape sequence. [/home/hudson/saved_omc/libraries/.openmodelica/libraries/AixLib 1.4.0-development/ThermalZones/HighOrder/Components/DryAir/InfiltrationRate_DIN12831.mo:20:192-20:4252:writable] Warning: Lexer treating \ as \\, since \ is not a valid Modelica escape sequence. [/home/hudson/saved_omc/libraries/.openmodelica/libraries/AixLib 1.4.0-development/DataBase/Weather/SurfaceOrientation/SurfaceOrientationData_N_E_S_W_RoofN_Roof_S.mo:5:35-5:362:writable] Warning: Lexer treating \ as \\, since \ is not a valid Modelica escape sequence. [/home/hudson/saved_omc/libraries/.openmodelica/libraries/AixLib 1.4.0-development/DataBase/Weather/SurfaceOrientation/SurfaceOrientationData_N_E_S_W_Hor.mo:5:35-5:320:writable] Warning: Lexer treating \ as \\, since \ is not a valid Modelica escape sequence. [/home/hudson/saved_omc/libraries/.openmodelica/libraries/AixLib 1.4.0-development/DataBase/Weather/SurfaceOrientation/SurfaceOrientationData_NE_SE_SW_NW_Hor.mo:5:35-5:324:writable] Warning: Lexer treating \ as \\, since \ is not a valid Modelica escape sequence. [/home/hudson/saved_omc/libraries/.openmodelica/libraries/AixLib 1.4.0-development/DataBase/CHP/CHPDataSimple/CHP_XRGI_9kWel.mo:25:34-25:588:writable] Warning: Lexer treating \ as \\, since \ is not a valid Modelica escape sequence. [/home/hudson/saved_omc/libraries/.openmodelica/libraries/AixLib 1.4.0-development/DataBase/CHP/CHPDataSimple/CHP_XRGI_9kWel.mo:25:34-25:3852:writable] Warning: Lexer treating \ as \\, since \ is not a valid Modelica escape sequence. [/home/hudson/saved_omc/libraries/.openmodelica/libraries/AixLib 1.4.0-development/DataBase/CHP/CHPDataSimple/CHP_Cleanergy_C9G.mo:36:34-36:594:writable] Warning: Lexer treating \ as \\, since \ is not a valid Modelica escape sequence. [/home/hudson/saved_omc/libraries/.openmodelica/libraries/AixLib 1.4.0-development/BoundaryConditions/InternalGains/Examples/InternalGains/Machines.mo:31:20-31:400:writable] Warning: Lexer treating \ as \\, since \ is not a valid Modelica escape sequence. [/home/hudson/saved_omc/libraries/.openmodelica/libraries/AixLib 1.4.0-development/BoundaryConditions/InternalGains/Examples/InternalGains/Lights.mo:27:20-27:398:writable] Warning: Lexer treating \ as \\, since \ is not a valid Modelica escape sequence. Notification: Performance of loadFile(/home/hudson/saved_omc/libraries/.openmodelica/libraries/AixLib 1.4.0-development/package.mo): time 1.792/1.792, allocations: 270.9 MB / 0.6665 GB, free: 15.26 MB / 478.1 MB Warning: Ignoring unknown experiment annotation option: __Dymola_Algorithm = "Dassl" Notification: Performance of FrontEnd - loaded program: time 0.0004593/0.0004594, allocations: 13.16 kB / 0.7881 GB, free: 31.4 MB / 0.545 GB Notification: Performance of FrontEnd - Absyn->SCode: time 0.1988/0.1992, allocations: 111 MB / 0.8964 GB, free: 12.45 MB / 0.6075 GB Notification: Performance of NFInst.instantiate(AixLib.Systems.ModularAHU.Examples.DemandControlledAHU): time 9.596/9.796, allocations: 3.62 GB / 4.517 GB, free: 6.422 MB / 1.748 GB Notification: Performance of NFInst.instExpressions: time 0.6868/10.48, allocations: 0.5283 GB / 5.045 GB, free: 14.33 MB / 2.045 GB Notification: Performance of NFInst.updateImplicitVariability: time 0.1142/10.6, allocations: 2.186 MB / 5.047 GB, free: 12.13 MB / 2.045 GB Notification: Performance of NFTyping.typeComponents: time 1.544/12.14, allocations: 30.31 MB / 5.077 GB, free: 9.898 MB / 2.045 GB [/home/hudson/saved_omc/libraries/.openmodelica/libraries/AixLib 1.4.0-development/ThermalZones/ReducedOrder/ThermalZone/ThermalZone.mo:325:47-325:67:writable] Warning: Conditional component ‘volMoiAir‘ is used in a non-connect context. [/home/hudson/saved_omc/libraries/.openmodelica/libraries/AixLib 1.4.0-development/ThermalZones/ReducedOrder/ThermalZone/ThermalZone.mo:454:55-454:74:writable] Warning: Conditional component ‘volMoiAir‘ is used in a non-connect context. [/home/hudson/saved_omc/libraries/.openmodelica/libraries/AixLib 1.4.0-development/ThermalZones/ReducedOrder/ThermalZone/ThermalZone.mo:472:71-475:46:writable] Warning: Conditional component ‘lights‘ is used in a non-connect context. [/home/hudson/saved_omc/libraries/.openmodelica/libraries/AixLib 1.4.0-development/ThermalZones/ReducedOrder/ThermalZone/ThermalZone.mo:472:71-475:46:writable] Warning: Conditional component ‘machinesSenHea‘ is used in a non-connect context. [/home/hudson/saved_omc/libraries/.openmodelica/libraries/AixLib 1.4.0-development/ThermalZones/ReducedOrder/ThermalZone/ThermalZone.mo:472:71-475:46:writable] Warning: Conditional component ‘humanTotHeaDependent‘ is used in a non-connect context. Notification: Performance of NFTyping.typeBindings: time 0.2026/12.34, allocations: 70.61 MB / 5.146 GB, free: 9.379 MB / 2.045 GB Notification: Performance of NFTyping.typeClassSections: time 0.131/12.47, allocations: 52.41 MB / 5.197 GB, free: 8.664 MB / 2.045 GB Notification: Performance of NFFlatten.flatten: time 0.2918/12.77, allocations: 229 MB / 5.421 GB, free: 12.49 MB / 2.061 GB Notification: Performance of NFFlatten.resolveConnections: time 0.1726/12.94, allocations: 70.91 MB / 5.49 GB, free: 4.723 MB / 2.092 GB Notification: Performance of NFEvalConstants.evaluate: time 0.1521/13.09, allocations: 51.17 MB / 5.54 GB, free: 13.52 MB / 2.139 GB Notification: Performance of NFSimplifyModel.simplify: time 0.1085/13.2, allocations: 47.73 MB / 5.587 GB, free: 6.32 MB / 2.17 GB Notification: Performance of NFPackage.collectConstants: time 0.02746/13.23, allocations: 2.738 MB / 5.589 GB, free: 3.582 MB / 2.17 GB Notification: Performance of NFFlatten.collectFunctions: time 0.118/13.35, allocations: 35.88 MB / 5.624 GB, free: 9.664 MB / 2.201 GB Notification: Performance of NFScalarize.scalarize: time 0.03456/13.38, allocations: 17.7 MB / 5.642 GB, free: 12.26 MB / 2.217 GB Notification: Performance of NFVerifyModel.verify: time 0.09252/13.47, allocations: 38.67 MB / 5.679 GB, free: 7.805 MB / 2.248 GB Notification: Performance of NFConvertDAE.convert: time 0.2273/13.7, allocations: 162.6 MB / 5.838 GB, free: 9.156 MB / 2.404 GB Notification: Performance of FrontEnd - DAE generated: time 5.901e-06/13.7, allocations: 4 kB / 5.838 GB, free: 9.152 MB / 2.404 GB Notification: Performance of FrontEnd: time 2.976e-06/13.7, allocations: 0 / 5.838 GB, free: 9.152 MB / 2.404 GB Notification: Performance of Transformations before backend: time 0.003609/13.7, allocations: 0 / 5.838 GB, free: 9.152 MB / 2.404 GB Notification: Model statistics after passing the front-end and creating the data structures used by the back-end: * Number of equations: 11457 * Number of variables: 11457 Notification: Performance of Generate backend data structure: time 0.1804/13.88, allocations: 68.55 MB / 5.905 GB, free: 4.652 MB / 2.467 GB Notification: Performance of prepare preOptimizeDAE: time 4.593e-05/13.88, allocations: 8.031 kB / 5.905 GB, free: 4.645 MB / 2.467 GB Notification: Performance of preOpt normalInlineFunction (simulation): time 1.13/15.01, allocations: 20.2 MB / 5.925 GB, free: 1.604 GB / 2.467 GB Notification: Performance of preOpt evaluateParameters (simulation): time 0.1683/15.18, allocations: 96.15 MB / 6.019 GB, free: 1.546 GB / 2.467 GB Notification: Performance of preOpt simplifyIfEquations (simulation): time 0.003472/15.19, allocations: 3.44 MB / 6.022 GB, free: 1.544 GB / 2.467 GB Notification: Performance of preOpt expandDerOperator (simulation): time 0.01863/15.2, allocations: 4.543 MB / 6.026 GB, free: 1.543 GB / 2.467 GB Notification: Performance of preOpt clockPartitioning (simulation): time 0.161/15.36, allocations: 67.25 MB / 6.092 GB, free: 1.503 GB / 2.467 GB Notification: Performance of preOpt findStateOrder (simulation): time 0.002301/15.37, allocations: 110.5 kB / 6.092 GB, free: 1.503 GB / 2.467 GB Notification: Performance of preOpt replaceEdgeChange (simulation): time 0.01304/15.38, allocations: 1.827 MB / 6.094 GB, free: 1.502 GB / 2.467 GB Notification: Performance of preOpt inlineArrayEqn (simulation): time 0.001736/15.38, allocations: 1.759 MB / 6.096 GB, free: 1.502 GB / 2.467 GB Notification: Performance of preOpt removeEqualRHS (simulation): time 0.1493/15.53, allocations: 64.07 MB / 6.158 GB, free: 1.464 GB / 2.467 GB Warning: The model contains alias variables with redundant start and/or conflicting nominal values. It is recommended to resolve the conflicts, because otherwise the system could be hard to solve. To print the conflicting alias sets and the chosen candidates please use -d=aliasConflicts. Notification: Performance of preOpt removeSimpleEquations (simulation): time 0.4324/15.96, allocations: 323 MB / 6.474 GB, free: 1.136 GB / 2.467 GB Notification: Performance of preOpt comSubExp (simulation): time 0.09092/16.05, allocations: 49.84 MB / 6.522 GB, free: 1.088 GB / 2.467 GB Notification: Performance of preOpt resolveLoops (simulation): time 0.04693/16.1, allocations: 23.95 MB / 6.546 GB, free: 1.065 GB / 2.467 GB Warning: The model contains alias variables with redundant start and/or conflicting nominal values. It is recommended to resolve the conflicts, because otherwise the system could be hard to solve. To print the conflicting alias sets and the chosen candidates please use -d=aliasConflicts. Notification: Performance of preOpt evalFunc (simulation): time 0.1831/16.28, allocations: 112.2 MB / 6.655 GB, free: 0.9505 GB / 2.467 GB Notification: Performance of preOpt encapsulateWhenConditions (simulation): time 0.05242/16.34, allocations: 23.94 MB / 6.679 GB, free: 0.9271 GB / 2.467 GB Notification: Performance of preOpt simplifyInStream (simulation): time 0.03159/16.37, allocations: 2.583 MB / 6.681 GB, free: 0.9246 GB / 2.467 GB Notification: Performance of pre-optimization done (n=2922): time 6.926e-05/16.37, allocations: 0 / 6.681 GB, free: 0.9246 GB / 2.467 GB Notification: Performance of matching and sorting (n=2958): time 0.4182/16.79, allocations: 154.3 MB / 6.832 GB, free: 0.7732 GB / 2.467 GB Notification: Performance of inlineWhenForInitialization (initialization): time 0.0002948/16.79, allocations: 0.6722 MB / 6.833 GB, free: 0.7725 GB / 2.467 GB Notification: Performance of selectInitializationVariablesDAE (initialization): time 0.1366/16.92, allocations: 69.74 MB / 6.901 GB, free: 0.7048 GB / 2.467 GB Notification: Performance of collectPreVariables (initialization): time 0.008121/16.93, allocations: 0.6046 MB / 6.901 GB, free: 0.7042 GB / 2.467 GB Notification: Performance of collectInitialEqns (initialization): time 0.03942/16.97, allocations: 32.6 MB / 6.933 GB, free: 0.6722 GB / 2.467 GB Notification: Performance of collectInitialBindings (initialization): time 0.01554/16.99, allocations: 10.35 MB / 6.943 GB, free: 0.6622 GB / 2.467 GB Notification: Performance of simplifyInitialFunctions (initialization): time 0.009673/17, allocations: 2.595 MB / 6.946 GB, free: 0.6597 GB / 2.467 GB Notification: Performance of setup shared object (initialization): time 4.22e-05/17, allocations: 308.3 kB / 6.946 GB, free: 0.6594 GB / 2.467 GB Notification: Performance of preBalanceInitialSystem (initialization): time 0.0441/17.04, allocations: 20.67 MB / 6.966 GB, free: 0.6392 GB / 2.467 GB Notification: Performance of partitionIndependentBlocks (initialization): time 0.04996/17.09, allocations: 26.6 MB / 6.992 GB, free: 0.6109 GB / 2.467 GB Warning: It was not possible to determine if the initialization problem is consistent, because of not evaluable parameters/start values during compile time: genericAHU.preheater.dynamicHX.vol1[1].dynBal.medium.p = genericAHU.preheater.dynamicHX.vol1[1].dynBal.p_start (101325.0 = genericAHU.preheater.dynamicHX.vol1[1].dynBal.p_start) Warning: It was not possible to determine if the initialization problem is consistent, because of not evaluable parameters/start values during compile time: genericAHU.cooler.dynamicHX.vol1[1].dynBal.medium.p = genericAHU.cooler.dynamicHX.vol1[1].dynBal.p_start (101325.0 = genericAHU.cooler.dynamicHX.vol1[1].dynBal.p_start) Warning: It was not possible to determine if the initialization problem is consistent, because of not evaluable parameters/start values during compile time: genericAHU.heater.dynamicHX.vol1[1].dynBal.medium.p = genericAHU.heater.dynamicHX.vol1[1].dynBal.p_start (101325.0 = genericAHU.heater.dynamicHX.vol1[1].dynBal.p_start) Notification: It was not possible to check the given initialization system for consistency symbolically, because the relevant equations are part of an algebraic loop. This is not supported yet. Warning: It was not possible to determine if the initialization problem is consistent, because of not evaluable parameters/start values during compile time: genericAHU.dynamicHX.vol2[1].dynBal.medium.p = genericAHU.dynamicHX.vol2[1].dynBal.p_start (101325.0 = genericAHU.dynamicHX.vol2[1].dynBal.p_start) Warning: It was not possible to determine if the initialization problem is consistent, because of not evaluable parameters/start values during compile time: genericAHU.fanSup.vol.dynBal.medium.p = genericAHU.fanSup.vol.dynBal.p_start (genericAHU.humidifier.vol.dynBal.p_start = genericAHU.fanSup.vol.dynBal.p_start) Notification: Performance of analyzeInitialSystem (initialization): time 1.64/18.73, allocations: 438.3 MB / 7.42 GB, free: 185.7 MB / 2.467 GB Notification: Performance of solveInitialSystemEqSystem (initialization): time 0.0001612/18.73, allocations: 44 kB / 7.42 GB, free: 185.6 MB / 2.467 GB Notification: Performance of matching and sorting (n=4144) (initialization): time 0.1404/18.87, allocations: 57.56 MB / 7.477 GB, free: 127.8 MB / 2.467 GB Notification: Performance of prepare postOptimizeDAE: time 0.002081/18.87, allocations: 5.137 MB / 7.482 GB, free: 120.5 MB / 2.467 GB Notification: Performance of postOpt simplifyComplexFunction (initialization): time 0.0004692/18.87, allocations: 204 kB / 7.482 GB, free: 120.3 MB / 2.467 GB Notification: Performance of postOpt tearingSystem (initialization): time 0.02389/18.9, allocations: 6.422 MB / 7.488 GB, free: 113.7 MB / 2.467 GB Notification: Performance of postOpt solveSimpleEquations (initialization): time 0.03783/18.94, allocations: 8.035 MB / 7.496 GB, free: 105.7 MB / 2.467 GB Notification: Performance of postOpt calculateStrongComponentJacobians (initialization): time 0.04856/18.98, allocations: 78.89 MB / 7.573 GB, free: 21.43 MB / 2.467 GB Notification: Performance of postOpt simplifyAllExpressions (initialization): time 0.05187/19.04, allocations: 4.52 MB / 7.577 GB, free: 16.92 MB / 2.467 GB Notification: Performance of postOpt collapseArrayExpressions (initialization): time 0.007364/19.04, allocations: 1.424 MB / 7.579 GB, free: 15.5 MB / 2.467 GB Notification: Performance of prepare postOptimizeDAE: time 1.109e-05/19.04, allocations: 4 kB / 7.579 GB, free: 15.5 MB / 2.467 GB Error: Internal error IndexReduction.pantelidesIndexReduction failed! System is structurally singular and cannot be handled because the number of unassigned equations is larger than the number of states. Use -d=bltdump to get more information. Notification: Performance of postOpt replaceHomotopyWithSimplified (initialization): time 1.141/20.19, allocations: 22.44 MB / 7.601 GB, free: 1.478 GB / 2.467 GB Error: post-optimization module replaceHomotopyWithSimplified (initialization) failed. Error: No system for the symbolic initialization was generated