Running: ./testmodel.py --libraries=/var/lib/hudson/saved_omc/libraries/.openmodelica/libraries/ --ompython_omhome=/usr Buildings_7.0.0_Buildings.Examples.VAVReheat.ASHRAE2006.conf.json
loadFile("/var/lib/hudson/saved_omc/libraries/.openmodelica/libraries/Buildings 7.0.1/package.mo", uses=false)
loadFile("/var/lib/hudson/saved_omc/libraries/.openmodelica/libraries/Complex 3.2.3+maint.om/package.mo", uses=false)
loadFile("/var/lib/hudson/saved_omc/libraries/.openmodelica/libraries/Modelica 3.2.3+maint.om/package.mo", uses=false)
loadFile("/var/lib/hudson/saved_omc/libraries/.openmodelica/libraries/ModelicaServices 3.2.3+maint.om/package.mo", uses=false)
Using package ModelicaServices with version 3.2.3 (/var/lib/hudson/saved_omc/libraries/.openmodelica/libraries/ModelicaServices 3.2.3+maint.om/package.mo)
Using package Modelica with version 3.2.3 (/var/lib/hudson/saved_omc/libraries/.openmodelica/libraries/Modelica 3.2.3+maint.om/package.mo)
Using package Complex with version 3.2.3 (/var/lib/hudson/saved_omc/libraries/.openmodelica/libraries/Complex 3.2.3+maint.om/package.mo)
Using package Buildings with version 7.0.1 (/var/lib/hudson/saved_omc/libraries/.openmodelica/libraries/Buildings 7.0.1/package.mo)
Running command: translateModel(Buildings.Examples.VAVReheat.ASHRAE2006,tolerance=1e-06,outputFormat="empty",numberOfIntervals=5000,variableFilter="",fileNamePrefix="Buildings_7.0.0_Buildings.Examples.VAVReheat.ASHRAE2006")
translateModel(Buildings.Examples.VAVReheat.ASHRAE2006,tolerance=1e-06,outputFormat="empty",numberOfIntervals=5000,variableFilter="",fileNamePrefix="Buildings_7.0.0_Buildings.Examples.VAVReheat.ASHRAE2006")
Notification: Performance of loadFile(/var/lib/hudson/saved_omc/libraries/.openmodelica/libraries/Buildings 7.0.1/package.mo): time 2.324/2.324, allocations: 251.3 MB / 266.2 MB, free: 11.52 MB / 218.7 MB
Notification: Performance of loadFile(/var/lib/hudson/saved_omc/libraries/.openmodelica/libraries/Complex 3.2.3+maint.om/package.mo): time 0.001339/0.001339, allocations: 180.3 kB / 325.8 MB, free: 2.789 MB / 250.7 MB
Notification: Performance of loadFile(/var/lib/hudson/saved_omc/libraries/.openmodelica/libraries/Modelica 3.2.3+maint.om/package.mo): time 2.652/2.652, allocations: 205.4 MB / 0.5767 GB, free: 20.7 MB / 426.7 MB
Notification: Performance of loadFile(/var/lib/hudson/saved_omc/libraries/.openmodelica/libraries/ModelicaServices 3.2.3+maint.om/package.mo): time 0.0009919/0.0009919, allocations: 91.91 kB / 0.6812 GB, free: 13.56 MB / 0.5105 GB
Notification: Performance of FrontEnd - loaded program: time 0.00048/0.0004802, allocations: 12.84 kB / 0.7953 GB, free: 135.6 MB / 0.6042 GB
Notification: Performance of FrontEnd - Absyn->SCode: time 0.2255/0.2261, allocations: 106.3 MB / 0.899 GB, free: 65.43 MB / 0.6042 GB
Notification: Performance of NFInst.instantiate(Buildings.Examples.VAVReheat.ASHRAE2006): time 6.393/6.619, allocations: 1.558 GB / 2.457 GB, free: 12.09 MB / 1.245 GB
Notification: Performance of NFInst.instExpressions: time 0.5543/7.173, allocations: 242 MB / 2.694 GB, free: 15.94 MB / 1.323 GB
Notification: Performance of NFInst.updateImplicitVariability: time 0.1174/7.291, allocations: 1.805 MB / 2.695 GB, free: 14.12 MB / 1.323 GB
Notification: Performance of NFTyping.typeComponents: time 0.1091/7.4, allocations: 23.04 MB / 2.718 GB, free: 8.34 MB / 1.339 GB
[/var/lib/hudson/saved_omc/libraries/.openmodelica/libraries/Buildings 7.0.1/BoundaryConditions/WeatherData/BaseClasses/getHeaderElementTMY3.mo:2:1-105:25:writable] Warning: Pure function ‘Buildings.BoundaryConditions.WeatherData.BaseClasses.getHeaderElementTMY3‘ contains a call to impure function ‘Modelica.Utilities.Streams.readLine‘.
[/var/lib/hudson/saved_omc/libraries/.openmodelica/libraries/Buildings 7.0.1/BoundaryConditions/WeatherData/BaseClasses/getLongitudeTMY3.mo:2:1-48:21:writable] Warning: Pure function ‘Buildings.BoundaryConditions.WeatherData.BaseClasses.getLongitudeTMY3‘ contains a call to impure function ‘Buildings.BoundaryConditions.WeatherData.BaseClasses.getHeaderElementTMY3‘.
[/var/lib/hudson/saved_omc/libraries/.openmodelica/libraries/Buildings 7.0.1/BoundaryConditions/WeatherData/BaseClasses/getLatitudeTMY3.mo:2:1-48:20:writable] Warning: Pure function ‘Buildings.BoundaryConditions.WeatherData.BaseClasses.getLatitudeTMY3‘ contains a call to impure function ‘Buildings.BoundaryConditions.WeatherData.BaseClasses.getHeaderElementTMY3‘.
[/var/lib/hudson/saved_omc/libraries/.openmodelica/libraries/Buildings 7.0.1/BoundaryConditions/WeatherData/BaseClasses/getTimeZoneTMY3.mo:2:1-47:20:writable] Warning: Pure function ‘Buildings.BoundaryConditions.WeatherData.BaseClasses.getTimeZoneTMY3‘ contains a call to impure function ‘Buildings.BoundaryConditions.WeatherData.BaseClasses.getHeaderElementTMY3‘.
[/var/lib/hudson/saved_omc/libraries/.openmodelica/libraries/Buildings 7.0.1/ThermalZones/Detailed/BaseClasses/ExteriorBoundaryConditionsWithWindow.mo:98:21-98:33:writable] Warning: 'each' used when modifying non-array element T.
[/var/lib/hudson/saved_omc/libraries/.openmodelica/libraries/Buildings 7.0.1/ThermalZones/Detailed/BaseClasses/ExteriorBoundaryConditionsWithWindow.mo:97:72-98:14:writable] Warning: 'each' used when modifying non-array element T.
[/var/lib/hudson/saved_omc/libraries/.openmodelica/libraries/Buildings 7.0.1/ThermalZones/Detailed/BaseClasses/ExteriorBoundaryConditionsWithWindow.mo:98:21-98:33:writable] Warning: 'each' used when modifying non-array element T.
[/var/lib/hudson/saved_omc/libraries/.openmodelica/libraries/Buildings 7.0.1/ThermalZones/Detailed/BaseClasses/ExteriorBoundaryConditionsWithWindow.mo:97:72-98:14:writable] Warning: 'each' used when modifying non-array element T.
[/var/lib/hudson/saved_omc/libraries/.openmodelica/libraries/Buildings 7.0.1/ThermalZones/Detailed/BaseClasses/ExteriorBoundaryConditionsWithWindow.mo:98:21-98:33:writable] Warning: 'each' used when modifying non-array element T.
[/var/lib/hudson/saved_omc/libraries/.openmodelica/libraries/Buildings 7.0.1/ThermalZones/Detailed/BaseClasses/ExteriorBoundaryConditionsWithWindow.mo:97:72-98:14:writable] Warning: 'each' used when modifying non-array element T.
[/var/lib/hudson/saved_omc/libraries/.openmodelica/libraries/Buildings 7.0.1/ThermalZones/Detailed/BaseClasses/ExteriorBoundaryConditionsWithWindow.mo:98:21-98:33:writable] Warning: 'each' used when modifying non-array element T.
[/var/lib/hudson/saved_omc/libraries/.openmodelica/libraries/Buildings 7.0.1/ThermalZones/Detailed/BaseClasses/ExteriorBoundaryConditionsWithWindow.mo:97:72-98:14:writable] Warning: 'each' used when modifying non-array element T.
Notification: Performance of NFTyping.typeBindings: time 0.1986/7.598, allocations: 43.42 MB / 2.76 GB, free: 4.258 MB / 1.37 GB
Notification: Performance of NFTyping.typeClassSections: time 0.1373/7.736, allocations: 28.63 MB / 2.788 GB, free: 10.59 MB / 1.401 GB
Notification: Performance of NFFlatten.flatten: time 3.315/11.05, allocations: 204.9 MB / 2.988 GB, free: 16.23 MB / 1.448 GB
Notification: Performance of NFFlatten.resolveConnections: time 0.2354/11.29, allocations: 72.89 MB / 3.059 GB, free: 22.11 MB / 1.464 GB
Notification: Performance of NFEvalConstants.evaluate: time 0.2183/11.5, allocations: 70.64 MB / 3.128 GB, free: 2.98 MB / 1.479 GB
Notification: Performance of NFSimplifyModel.simplify: time 0.1806/11.68, allocations: 64.17 MB / 3.191 GB, free: 15.46 MB / 1.542 GB
Notification: Performance of NFPackage.collectConstants: time 0.0494/11.73, allocations: 4.957 MB / 3.196 GB, free: 10.51 MB / 1.542 GB
Notification: Performance of NFFlatten.collectFunctions: time 0.1182/11.85, allocations: 20.24 MB / 3.216 GB, free: 10.04 MB / 1.557 GB
Notification: Performance of NFScalarize.scalarize: time 0.08276/11.94, allocations: 35.89 MB / 3.251 GB, free: 14.23 MB / 1.589 GB
Notification: Performance of NFVerifyModel.verify: time 0.06712/12, allocations: 23.93 MB / 3.274 GB, free: 2.059 MB / 1.589 GB
Notification: Performance of NFConvertDAE.convert: time 0.321/12.32, allocations: 185.8 MB / 3.456 GB, free: 4.312 MB / 1.745 GB
Notification: Performance of FrontEnd - DAE generated: time 5.971e-06/12.32, allocations: 4 kB / 3.456 GB, free: 4.309 MB / 1.745 GB
Notification: Performance of FrontEnd: time 3.016e-06/12.32, allocations: 0 / 3.456 GB, free: 4.309 MB / 1.745 GB
Notification: Performance of Transformations before backend: time 0.00615/12.33, allocations: 4 kB / 3.456 GB, free: 4.305 MB / 1.745 GB
Notification: Model statistics after passing the front-end and creating the data structures used by the back-end:
 * Number of equations: 11468
 * Number of variables: 11468
Notification: Performance of Generate backend data structure: time 2.146/14.48, allocations: 122 MB / 3.575 GB, free: 0.9038 GB / 1.776 GB
Notification: Performance of prepare preOptimizeDAE: time 4.861e-05/14.48, allocations: 11.78 kB / 3.575 GB, free: 0.9038 GB / 1.776 GB
Notification: Performance of preOpt normalInlineFunction (simulation): time 0.22/14.7, allocations: 26.75 MB / 3.601 GB, free: 0.8922 GB / 1.776 GB
Notification: Performance of preOpt evaluateParameters (simulation): time 0.385/15.08, allocations: 143.9 MB / 3.741 GB, free: 0.7754 GB / 1.776 GB
Notification: Performance of preOpt simplifyIfEquations (simulation): time 0.01565/15.1, allocations: 7.487 MB / 3.749 GB, free: 0.7676 GB / 1.776 GB
Notification: Performance of preOpt expandDerOperator (simulation): time 0.03545/15.13, allocations: 5.4 MB / 3.754 GB, free: 0.7623 GB / 1.776 GB
Notification: Performance of preOpt clockPartitioning (simulation): time 0.2834/15.42, allocations: 73.84 MB / 3.826 GB, free: 0.6888 GB / 1.776 GB
Notification: Performance of preOpt findStateOrder (simulation): time 0.002471/15.42, allocations: 95.14 kB / 3.826 GB, free: 0.6887 GB / 1.776 GB
Notification: Performance of preOpt replaceEdgeChange (simulation): time 0.01926/15.44, allocations: 1.826 MB / 3.828 GB, free: 0.687 GB / 1.776 GB
Notification: Performance of preOpt inlineArrayEqn (simulation): time 0.001842/15.44, allocations: 1.705 MB / 3.83 GB, free: 0.6853 GB / 1.776 GB
Notification: Performance of preOpt removeEqualRHS (simulation): time 0.2646/15.7, allocations: 71.12 MB / 3.899 GB, free: 0.616 GB / 1.776 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 1.023/16.73, allocations: 403.2 MB / 4.293 GB, free: 218.7 MB / 1.776 GB
Notification: Performance of preOpt comSubExp (simulation): time 0.1752/16.9, allocations: 58.11 MB / 4.35 GB, free: 160.2 MB / 1.776 GB
Notification: Performance of preOpt resolveLoops (simulation): time 0.09642/17, allocations: 32.76 MB / 4.382 GB, free: 127.3 MB / 1.776 GB
Notification: Performance of preOpt evalFunc (simulation): time 0.01164/17.01, allocations: 6.531 MB / 4.388 GB, free: 119.6 MB / 1.776 GB
Notification: Performance of preOpt encapsulateWhenConditions (simulation): time 0.1055/17.12, allocations: 32.52 MB / 4.42 GB, free: 86.95 MB / 1.776 GB
Notification: Performance of preOpt simplifyInStream (simulation): time 0.08819/17.2, allocations: 6.875 MB / 4.426 GB, free: 80.07 MB / 1.776 GB
Notification: Performance of pre-optimization done (n=3286): time 0.0001033/17.2, allocations: 4 kB / 4.426 GB, free: 80.07 MB / 1.776 GB
Notification: Performance of matching and sorting (n=3301): time 2.491/19.7, allocations: 374.2 MB / 4.792 GB, free: 0.6967 GB / 1.776 GB
Notification: Performance of inlineWhenForInitialization (initialization): time 0.001848/19.7, allocations: 2.654 MB / 4.794 GB, free: 0.6944 GB / 1.776 GB
Notification: Performance of selectInitializationVariablesDAE (initialization): time 0.5057/20.2, allocations: 189.1 MB / 4.979 GB, free: 0.5539 GB / 1.776 GB
Notification: Performance of collectPreVariables (initialization): time 0.02098/20.22, allocations: 1.137 MB / 4.98 GB, free: 0.5527 GB / 1.776 GB
Notification: Performance of collectInitialEqns (initialization): time 0.1039/20.33, allocations: 49.06 MB / 5.028 GB, free: 0.5057 GB / 1.776 GB
Notification: Performance of collectInitialBindings (initialization): time 0.02325/20.35, allocations: 11.34 MB / 5.039 GB, free: 0.4947 GB / 1.776 GB
Notification: Performance of simplifyInitialFunctions (initialization): time 0.01828/20.37, allocations: 1.087 MB / 5.04 GB, free: 0.4936 GB / 1.776 GB
Notification: Performance of setup shared object (initialization): time 0.006595/20.38, allocations: 2.729 MB / 5.043 GB, free: 0.491 GB / 1.776 GB
Notification: Performance of preBalanceInitialSystem (initialization): time 0.1818/20.56, allocations: 79.46 MB / 5.121 GB, free: 423.4 MB / 1.776 GB
Notification: Performance of partitionIndependentBlocks (initialization): time 0.2075/20.77, allocations: 96.25 MB / 5.215 GB, free: 321.9 MB / 1.776 GB
Warning: It was not possible to determine if the initialization problem is consistent, because of not evaluable parameters/start values during compile time: cooCoi.ele[1].vol2.dynBal.medium.p = cooCoi.ele[1].vol2.dynBal.p_start (fanSup.vol.dynBal.p_start = cooCoi.ele[1].vol2.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: flo.wes.air.vol.dynBal.medium.p = flo.wes.air.vol.dynBal.p_start (flo.cor.air.vol.dynBal.p_start = flo.wes.air.vol.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: flo.sou.air.vol.dynBal.medium.p = flo.sou.air.vol.dynBal.p_start (flo.cor.air.vol.dynBal.p_start = flo.sou.air.vol.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: flo.nor.air.vol.dynBal.medium.p = flo.nor.air.vol.dynBal.p_start (flo.cor.air.vol.dynBal.p_start = flo.nor.air.vol.dynBal.p_start)
Notification: Performance of analyzeInitialSystem (initialization): time 5.679/26.44, allocations: 0.7581 GB / 5.973 GB, free: 462.6 MB / 1.776 GB
Notification: Performance of solveInitialSystemEqSystem (initialization): time 0.0005533/26.45, allocations: 100 kB / 5.973 GB, free: 462.5 MB / 1.776 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.
Error: No system for the symbolic initialization was generated