Running: ./testmodel.py --libraries=/home/hudson/saved_omc/libraries/.openmodelica/libraries --ompython_omhome=/usr Buildings_10_Buildings.ThermalZones.ISO13790.Validation.BESTEST.Case900.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/Buildings 10.1.1-maint.10.0.x/package.mo", uses=false)
Using package Buildings with version 10.1.1 (/home/hudson/saved_omc/libraries/.openmodelica/libraries/Buildings 10.1.1-maint.10.0.x/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(Buildings.ThermalZones.ISO13790.Validation.BESTEST.Case900,tolerance=1e-06,outputFormat="mat",numberOfIntervals=5000,variableFilter="time|EHea.y|ECoo.y",fileNamePrefix="Buildings_10_Buildings.ThermalZones.ISO13790.Validation.BESTEST.Case900")
translateModel(Buildings.ThermalZones.ISO13790.Validation.BESTEST.Case900,tolerance=1e-06,outputFormat="mat",numberOfIntervals=5000,variableFilter="time|EHea.y|ECoo.y",fileNamePrefix="Buildings_10_Buildings.ThermalZones.ISO13790.Validation.BESTEST.Case900")
Notification: Performance of loadFile(/home/hudson/saved_omc/libraries/.openmodelica/libraries/ModelicaServices 4.0.0+maint.om/package.mo): time 0.001409/0.001409, allocations: 109 kB / 16.42 MB, free: 6.512 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.00157/0.00157, allocations: 188.3 kB / 17.35 MB, free: 5.738 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.245/1.245, allocations: 222.9 MB / 241 MB, free: 15.15 MB / 206.1 MB
Notification: Performance of loadFile(/home/hudson/saved_omc/libraries/.openmodelica/libraries/Buildings 10.1.1-maint.10.0.x/package.mo): time 2.328/2.328, allocations: 437 MB / 0.7112 GB, free: 4.352 MB / 0.5762 GB
Notification: Performance of FrontEnd - loaded program: time 0.00128/0.00128, allocations: 60.12 kB / 1.019 GB, free: 9.383 MB / 0.795 GB
Notification: Performance of FrontEnd - Absyn->SCode: time 0.7014/0.7027, allocations: 151.6 MB / 1.167 GB, free: 3.793 MB / 0.8887 GB
Notification: Performance of NFInst.instantiate(Buildings.ThermalZones.ISO13790.Validation.BESTEST.Case900): time 0.01651/0.7193, allocations: 15.49 MB / 1.182 GB, free: 4.23 MB / 0.9044 GB
Notification: Performance of NFInst.instExpressions: time 0.1501/0.8694, allocations: 154.2 MB / 1.333 GB, free: 9.398 MB / 1.061 GB
Notification: Performance of NFInst.updateImplicitVariability: time 0.003234/0.8727, allocations: 59.75 kB / 1.333 GB, free: 9.34 MB / 1.061 GB
Notification: Performance of NFTyping.typeComponents: time 0.002947/0.8757, allocations: 1.41 MB / 1.334 GB, free: 7.922 MB / 1.061 GB
Notification: Performance of NFTyping.typeBindings: time 0.00532/0.8811, allocations: 1.857 MB / 1.336 GB, free: 6.059 MB / 1.061 GB
Notification: Performance of NFTyping.typeClassSections: time 0.004669/0.8857, allocations: 2.343 MB / 1.339 GB, free: 3.727 MB / 1.061 GB
Notification: Performance of NFFlatten.flatten: time 0.01192/0.8977, allocations: 12.37 MB / 1.351 GB, free: 7.316 MB / 1.076 GB
Notification: Performance of NFFlatten.resolveConnections: time 0.01117/0.9089, allocations: 8.803 MB / 1.359 GB, free: 14.4 MB / 1.092 GB
Notification: Performance of NFEvalConstants.evaluate: time 0.007748/0.9166, allocations: 5.544 MB / 1.365 GB, free: 8.844 MB / 1.092 GB
Notification: Performance of NFSimplifyModel.simplify: time 0.007399/0.924, allocations: 6.168 MB / 1.371 GB, free: 2.656 MB / 1.092 GB
Notification: Performance of NFPackage.collectConstants: time 0.003366/0.9274, allocations: 1.832 MB / 1.372 GB, free: 0.8242 MB / 1.092 GB
Notification: Performance of NFFlatten.collectFunctions: time 0.004776/0.9322, allocations: 2.254 MB / 1.375 GB, free: 14.57 MB / 1.107 GB
Notification: Performance of NFScalarize.scalarize: time 0.004055/0.9363, allocations: 3.43 MB / 1.378 GB, free: 11.13 MB / 1.107 GB
Notification: Performance of NFVerifyModel.verify: time 0.008924/0.9452, allocations: 6.233 MB / 1.384 GB, free: 4.875 MB / 1.107 GB
Notification: Performance of NFConvertDAE.convert: time 0.01864/0.9639, allocations: 20.31 MB / 1.404 GB, free: 0.5078 MB / 1.123 GB
Notification: Performance of FrontEnd - DAE generated: time 5.921e-06/0.9639, allocations: 0 / 1.404 GB, free: 0.5078 MB / 1.123 GB
Notification: Performance of FrontEnd: time 1.573e-06/0.9639, allocations: 0 / 1.404 GB, free: 0.5078 MB / 1.123 GB
Notification: Performance of Transformations before backend: time 0.0005532/0.9645, allocations: 0 / 1.404 GB, free: 0.5078 MB / 1.123 GB
Notification: Model statistics after passing the front-end and creating the data structures used by the back-end:
 * Number of equations: 2273
 * Number of variables: 2273
Notification: Performance of Generate backend data structure: time 0.03242/0.9969, allocations: 11.28 MB / 1.415 GB, free: 5.09 MB / 1.139 GB
Notification: Performance of prepare preOptimizeDAE: time 4.696e-05/0.997, allocations: 12.92 kB / 1.415 GB, free: 5.078 MB / 1.139 GB
Notification: Performance of preOpt normalInlineFunction (simulation): time 0.05624/1.053, allocations: 10.92 MB / 1.426 GB, free: 10.12 MB / 1.154 GB
Notification: Performance of preOpt evaluateParameters (simulation): time 0.01314/1.066, allocations: 5.835 MB / 1.431 GB, free: 4.227 MB / 1.154 GB
Notification: Performance of preOpt simplifyIfEquations (simulation): time 0.0006755/1.067, allocations: 0.6463 MB / 1.432 GB, free: 3.578 MB / 1.154 GB
Notification: Performance of preOpt expandDerOperator (simulation): time 0.003903/1.071, allocations: 0.8398 MB / 1.433 GB, free: 2.738 MB / 1.154 GB
Notification: Performance of preOpt clockPartitioning (simulation): time 0.05006/1.121, allocations: 18.11 MB / 1.451 GB, free: 0.4922 MB / 1.17 GB
Notification: Performance of preOpt findStateOrder (simulation): time 0.0002284/1.121, allocations: 0 / 1.451 GB, free: 0.4922 MB / 1.17 GB
Notification: Performance of preOpt replaceEdgeChange (simulation): time 0.002935/1.124, allocations: 360 kB / 1.451 GB, free: 144 kB / 1.17 GB
Notification: Performance of preOpt inlineArrayEqn (simulation): time 0.0001874/1.125, allocations: 212 kB / 1.451 GB, free: 15.93 MB / 1.186 GB
Notification: Performance of preOpt removeEqualRHS (simulation): time 0.06259/1.187, allocations: 23.13 MB / 1.474 GB, free: 8.77 MB / 1.201 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.08862/1.276, allocations: 42.98 MB / 1.516 GB, free: 13 MB / 1.248 GB
Notification: Performance of preOpt comSubExp (simulation): time 0.03849/1.314, allocations: 14.03 MB / 1.529 GB, free: 14.95 MB / 1.264 GB
Notification: Performance of preOpt resolveLoops (simulation): time 0.0207/1.335, allocations: 7.752 MB / 1.537 GB, free: 7.172 MB / 1.264 GB
Notification: Performance of preOpt evalFunc (simulation): time 0.001432/1.337, allocations: 0.6465 MB / 1.538 GB, free: 6.43 MB / 1.264 GB
Notification: Performance of preOpt encapsulateWhenConditions (simulation): time 0.02402/1.361, allocations: 8.659 MB / 1.546 GB, free: 13.7 MB / 1.279 GB
Notification: Performance of pre-optimization done (n=667): time 1.257e-05/1.361, allocations: 0 / 1.546 GB, free: 13.7 MB / 1.279 GB
Notification: Performance of matching and sorting (n=667): time 1.148/2.509, allocations: 22.65 MB / 1.568 GB, free: 357.3 MB / 1.279 GB
Notification: Performance of inlineWhenForInitialization (initialization): time 9.265e-05/2.509, allocations: 273.7 kB / 1.568 GB, free: 357 MB / 1.279 GB
Notification: Performance of selectInitializationVariablesDAE (initialization): time 0.006079/2.515, allocations: 5.574 MB / 1.574 GB, free: 355.1 MB / 1.279 GB
Notification: Performance of collectPreVariables (initialization): time 0.001702/2.517, allocations: 160.7 kB / 1.574 GB, free: 355 MB / 1.279 GB
Notification: Performance of collectInitialEqns (initialization): time 0.002194/2.519, allocations: 3.294 MB / 1.577 GB, free: 352.9 MB / 1.279 GB
Notification: Performance of collectInitialBindings (initialization): time 0.002494/2.521, allocations: 2.169 MB / 1.579 GB, free: 351.2 MB / 1.279 GB
Notification: Performance of simplifyInitialFunctions (initialization): time 0.002413/2.524, allocations: 1.289 MB / 1.581 GB, free: 350.7 MB / 1.279 GB
Notification: Performance of setup shared object (initialization): time 3.64e-05/2.524, allocations: 305.1 kB / 1.581 GB, free: 350.4 MB / 1.279 GB
Notification: Performance of preBalanceInitialSystem (initialization): time 0.01487/2.539, allocations: 6.827 MB / 1.587 GB, free: 348.1 MB / 1.279 GB
Notification: Performance of partitionIndependentBlocks (initialization): time 0.01696/2.556, allocations: 7.435 MB / 1.595 GB, free: 345.4 MB / 1.279 GB
Notification: Performance of analyzeInitialSystem (initialization): time 0.03237/2.588, allocations: 13.75 MB / 1.608 GB, free: 334.4 MB / 1.279 GB
Notification: Performance of solveInitialSystemEqSystem (initialization): time 2.184e-05/2.588, allocations: 4 kB / 1.608 GB, free: 334.4 MB / 1.279 GB
Notification: Performance of matching and sorting (n=781) (initialization): time 0.04408/2.632, allocations: 15.44 MB / 1.623 GB, free: 318.8 MB / 1.279 GB
Notification: Performance of prepare postOptimizeDAE: time 3.721e-05/2.632, allocations: 12 kB / 1.623 GB, free: 318.8 MB / 1.279 GB
Notification: Performance of postOpt simplifyComplexFunction (initialization): time 2.735e-05/2.632, allocations: 11.98 kB / 1.623 GB, free: 318.8 MB / 1.279 GB
Notification: Performance of postOpt tearingSystem (initialization): time 0.001347/2.634, allocations: 345.4 kB / 1.624 GB, free: 318.5 MB / 1.279 GB
Notification: Performance of postOpt solveSimpleEquations (initialization): time 0.0139/2.648, allocations: 2.352 MB / 1.626 GB, free: 316.1 MB / 1.279 GB
Notification: Performance of postOpt calculateStrongComponentJacobians (initialization): time 0.00602/2.654, allocations: 5.12 MB / 1.631 GB, free: 310.7 MB / 1.279 GB
Notification: Performance of postOpt simplifyAllExpressions (initialization): time 0.01191/2.666, allocations: 1.611 MB / 1.632 GB, free: 309.1 MB / 1.279 GB
Notification: Performance of postOpt collapseArrayExpressions (initialization): time 0.002345/2.668, allocations: 307.7 kB / 1.633 GB, free: 308.8 MB / 1.279 GB
Notification: Model statistics after passing the back-end for initialization:
 * Number of independent subsystems: 32
 * Number of states: 0 ()
 * Number of discrete variables: 80 ($PRE.daiComBESTEST.nextTimeEvent,$whenCondition24,daiComBESTEST.nextTimeEventScaled,$PRE.daiComBESTEST.nextTimeEventScaled,daiComBESTEST.nextTimeEvent,weaDat.conTim.canRepeatWeatherFile,weaDat.conTimMin.canRepeatWeatherFile,weaDat.decAng.tNext,$PRE.weaDat.decAng.tNext,weaDat.eqnTim.tNext,$PRE.weaDat.eqnTim.tNext,weaDat.conTim.tNext,$PRE.weaDat.conTim.tNext,weaDat.conTimMin.tNext,$PRE.weaDat.conTimMin.tNext,weaDat.locTim.tNext,$PRE.weaDat.locTim.tNext,zon5R1C.opa.HDifTilRof.incAng.decAng.tNext,$PRE.zon5R1C.opa.HDifTilRof.incAng.decAng.tNext,zon5R1C.opa.HDirTilRoo.incAng.decAng.tNext,$PRE.zon5R1C.opa.HDirTilRoo.incAng.decAng.tNext,zon5R1C.opa.HDifTil[4].incAng.decAng.tNext,$PRE.zon5R1C.opa.HDifTil[4].incAng.decAng.tNext,zon5R1C.opa.HDifTil[3].incAng.decAng.tNext,$PRE.zon5R1C.opa.HDifTil[3].incAng.decAng.tNext,zon5R1C.opa.HDifTil[2].incAng.decAng.tNext,$PRE.zon5R1C.opa.HDifTil[2].incAng.decAng.tNext,zon5R1C.opa.HDifTil[1].incAng.decAng.tNext,$PRE.zon5R1C.opa.HDifTil[1].incAng.decAng.tNext,zon5R1C.opa.HDirTil[4].incAng.decAng.tNext,$PRE.zon5R1C.opa.HDirTil[4].incAng.decAng.tNext,zon5R1C.opa.HDirTil[3].incAng.decAng.tNext,$PRE.zon5R1C.opa.HDirTil[3].incAng.decAng.tNext,zon5R1C.opa.HDirTil[2].incAng.decAng.tNext,$PRE.zon5R1C.opa.HDirTil[2].incAng.decAng.tNext,zon5R1C.opa.HDirTil[1].incAng.decAng.tNext,$PRE.zon5R1C.opa.HDirTil[1].incAng.decAng.tNext,zon5R1C.win.HDifTil[4].incAng.decAng.tNext,$PRE.zon5R1C.win.HDifTil[4].incAng.decAng.tNext,zon5R1C.win.HDifTil[3].incAng.decAng.tNext,$PRE.zon5R1C.win.HDifTil[3].incAng.decAng.tNext,zon5R1C.win.HDifTil[2].incAng.decAng.tNext,$PRE.zon5R1C.win.HDifTil[2].incAng.decAng.tNext,zon5R1C.win.HDifTil[1].incAng.decAng.tNext,$PRE.zon5R1C.win.HDifTil[1].incAng.decAng.tNext,zon5R1C.win.HDirTil[4].incAng.decAng.tNext,$PRE.zon5R1C.win.HDirTil[4].incAng.decAng.tNext,zon5R1C.win.HDirTil[3].incAng.decAng.tNext,$PRE.zon5R1C.win.HDirTil[3].incAng.decAng.tNext,zon5R1C.win.HDirTil[2].incAng.decAng.tNext,$PRE.zon5R1C.win.HDirTil[2].incAng.decAng.tNext,zon5R1C.win.HDirTil[1].incAng.decAng.tNext,$PRE.zon5R1C.win.HDirTil[1].incAng.decAng.tNext,$whenCondition1,$whenCondition2,$whenCondition3,$whenCondition4,$whenCondition5,$whenCondition6,$whenCondition7,$whenCondition8,$whenCondition9,$whenCondition10,$whenCondition11,$whenCondition12,$whenCondition13,$whenCondition14,$whenCondition15,$whenCondition16,$whenCondition17,$whenCondition18,$whenCondition19,$whenCondition20,$whenCondition21,$whenCondition22,$whenCondition23,EHea.local_reset,ECoo.local_reset,conCooPID.I.trigger_internal,conHeaPID.I.trigger_internal)
 * Number of discrete states: 0 ()
 * Number of clocked states: 0 ()
 * Top-level inputs: 0
Notification: Strong component statistics for initialization (753):
 * Single equations (assignments): 751
 * Array equations: 0
 * Algorithm blocks: 0
 * Record equations: 0
 * When equations: 0
 * If-equations: 0
 * Equation systems (not torn): 0
 * Torn equation systems: 2
 * Mixed (continuous/discrete) equation systems: 0
Notification: Torn system details for strict tearing set:
 * Linear torn systems (#iteration vars, #inner vars, density): 0 systems
 * Non-linear torn systems (#iteration vars, #inner vars): 2 systems
   {(2,25), (1,2)}
Notification: Performance of prepare postOptimizeDAE: time 0.007249/2.675, allocations: 3.017 MB / 1.636 GB, free: 305.8 MB / 1.279 GB
Notification: Performance of postOpt lateInlineFunction (simulation): time 0.00263/2.678, allocations: 0.571 MB / 1.636 GB, free: 305.2 MB / 1.279 GB
Notification: Performance of postOpt wrapFunctionCalls (simulation): time 0.04791/2.726, allocations: 17.08 MB / 1.653 GB, free: 288.1 MB / 1.279 GB
Notification: Performance of postOpt simplifysemiLinear (simulation): time 0.0002095/2.726, allocations: 35.81 kB / 1.653 GB, free: 288 MB / 1.279 GB
Notification: Performance of postOpt simplifyComplexFunction (simulation): time 1.535e-05/2.726, allocations: 3.984 kB / 1.653 GB, free: 288 MB / 1.279 GB
Notification: Performance of postOpt removeConstants (simulation): time 0.006245/2.732, allocations: 2.397 MB / 1.655 GB, free: 285.6 MB / 1.279 GB
Notification: Performance of postOpt simplifyTimeIndepFuncCalls (simulation): time 0.002531/2.735, allocations: 202.9 kB / 1.656 GB, free: 285.4 MB / 1.279 GB
Notification: Performance of postOpt simplifyAllExpressions (simulation): time 0.0109/2.746, allocations: 1.229 MB / 1.657 GB, free: 284.2 MB / 1.279 GB
Notification: Performance of postOpt findZeroCrossings (simulation): time 0.001866/2.748, allocations: 0.5008 MB / 1.657 GB, free: 283.7 MB / 1.279 GB
Notification: Performance of postOpt createDAEmodeBDAE (simulation): time 0.04866/2.796, allocations: 16.27 MB / 1.673 GB, free: 267.4 MB / 1.279 GB
Notification: Performance of postOpt symbolicJacobianDAE (simulation): time 0.05896/2.855, allocations: 25.22 MB / 1.698 GB, free: 242.1 MB / 1.279 GB
Notification: Performance of postOpt setEvaluationStage (simulation): time 0.01723/2.873, allocations: 7.524 MB / 1.705 GB, free: 234.6 MB / 1.279 GB
Notification: Performance of sorting global known variables: time 0.005928/2.879, allocations: 4.248 MB / 1.709 GB, free: 230.3 MB / 1.279 GB
Notification: Performance of Backend: time 6.41e-07/2.879, allocations: 0 / 1.709 GB, free: 230.3 MB / 1.279 GB
Notification: Performance of simCode: created initialization part: time 0.03089/2.91, allocations: 10.04 MB / 1.719 GB, free: 220.7 MB / 1.279 GB
Notification: Performance of SimCode: time 0.02581/2.936, allocations: 15.64 MB / 1.734 GB, free: 205 MB / 1.279 GB
Notification: Performance of Templates: time 0.1812/3.117, allocations: 151.5 MB / 1.882 GB, free: 53.93 MB / 1.279 GB
make -j1 -f Buildings_10_Buildings.ThermalZones.ISO13790.Validation.BESTEST.Case900.makefile
(rm -f Buildings_10_Buildings.ThermalZones.ISO13790.Validation.BESTEST.Case900.pipe ; mkfifo Buildings_10_Buildings.ThermalZones.ISO13790.Validation.BESTEST.Case900.pipe ; head -c 1048576 < Buildings_10_Buildings.ThermalZones.ISO13790.Validation.BESTEST.Case900.pipe >> ../files/Buildings_10_Buildings.ThermalZones.ISO13790.Validation.BESTEST.Case900.sim & ./Buildings_10_Buildings.ThermalZones.ISO13790.Validation.BESTEST.Case900  -abortSlowSimulation -alarm=480  -emit_protected -lv LOG_STATS > Buildings_10_Buildings.ThermalZones.ISO13790.Validation.BESTEST.Case900.pipe 2>&1)