Running: ./testmodel.py --libraries=/home/hudson/saved_omc/libraries/.openmodelica/libraries --ompython_omhome=/usr Buildings_12_Buildings.Air.Systems.SingleZone.VAV.Examples.OptimalStart.ConventionalSummer.conf.json
loadFile("/home/hudson/saved_omc/libraries/.openmodelica/libraries/ModelicaServices 4.1.0+maint.om/package.mo", uses=false) [Timeout 180]
"Notification: Performance of loadFile(/home/hudson/saved_omc/libraries/.openmodelica/libraries/ModelicaServices 4.1.0+maint.om/package.mo): time 0.001479/0.001479, allocations: 104.3 kB / 19.77 MB, free: 2.051 MB / 14.72 MB
"
[Timeout remaining time 180]
loadFile("/home/hudson/saved_omc/libraries/.openmodelica/libraries/Complex 4.1.0+maint.om/package.mo", uses=false) [Timeout 180]
"Notification: Performance of loadFile(/home/hudson/saved_omc/libraries/.openmodelica/libraries/Complex 4.1.0+maint.om/package.mo): time 0.001568/0.001568, allocations: 213.1 kB / 23.07 MB, free: 4.844 MB / 14.72 MB
"
[Timeout remaining time 180]
loadFile("/home/hudson/saved_omc/libraries/.openmodelica/libraries/Modelica 4.1.0+maint.om/package.mo", uses=false) [Timeout 180]
"Notification: Performance of loadFile(/home/hudson/saved_omc/libraries/.openmodelica/libraries/Modelica 4.1.0+maint.om/package.mo): time 1.321/1.321, allocations: 230.7 MB / 256.9 MB, free: 7.723 MB / 206.1 MB
"
[Timeout remaining time 179]
loadFile("/home/hudson/saved_omc/libraries/.openmodelica/libraries/Buildings 12.1.1-maint.12.x/package.mo", uses=false) [Timeout 180]
"Notification: Performance of loadFile(/home/hudson/saved_omc/libraries/.openmodelica/libraries/Buildings 12.1.1-maint.12.x/package.mo): time 2.896/2.896, allocations: 0.4893 GB / 0.7952 GB, free: 35.6 MB / 0.6231 GB
"
[Timeout remaining time 177]
Using package Buildings with version 12.1.1 (/home/hudson/saved_omc/libraries/.openmodelica/libraries/Buildings 12.1.1-maint.12.x/package.mo)
Using package Modelica with version 4.1.0 (/home/hudson/saved_omc/libraries/.openmodelica/libraries/Modelica 4.1.0+maint.om/package.mo)
Using package Complex with version 4.1.0 (/home/hudson/saved_omc/libraries/.openmodelica/libraries/Complex 4.1.0+maint.om/package.mo)
Using package ModelicaServices with version 4.1.0 (/home/hudson/saved_omc/libraries/.openmodelica/libraries/ModelicaServices 4.1.0+maint.om/package.mo)
Running command: translateModel(Buildings.Air.Systems.SingleZone.VAV.Examples.OptimalStart.ConventionalSummer,tolerance=1e-06,outputFormat="mat",numberOfIntervals=2500,variableFilter="time|TSetRooHea.y.1.|TSetRooCoo.y.1.|zonAHUOpt.TZon|zonAHUCon.TZon|optSta.tOpt",fileNamePrefix="Buildings_12_Buildings.Air.Systems.SingleZone.VAV.Examples.OptimalStart.ConventionalSummer")
translateModel(Buildings.Air.Systems.SingleZone.VAV.Examples.OptimalStart.ConventionalSummer,tolerance=1e-06,outputFormat="mat",numberOfIntervals=2500,variableFilter="time|TSetRooHea.y.1.|TSetRooCoo.y.1.|zonAHUOpt.TZon|zonAHUCon.TZon|optSta.tOpt",fileNamePrefix="Buildings_12_Buildings.Air.Systems.SingleZone.VAV.Examples.OptimalStart.ConventionalSummer") [Timeout 300]
"Notification: Performance of FrontEnd - Absyn->SCode: time 1.862e-05/1.862e-05, allocations: 4.109 kB / 1.154 GB, free: 25.47 MB / 0.9044 GB
Notification: Performance of NFInst.instantiate(Buildings.Air.Systems.SingleZone.VAV.Examples.OptimalStart.ConventionalSummer): time 1.65/1.65, allocations: 0.8658 GB / 2.02 GB, free: 2.875 MB / 1.42 GB
Notification: Performance of NFInst.instExpressions: time 0.3302/1.98, allocations: 196.7 MB / 2.212 GB, free: 13.73 MB / 1.623 GB
Notification: Performance of NFInst.updateImplicitVariability: time 0.05026/2.03, allocations: 1.713 MB / 2.214 GB, free: 12 MB / 1.623 GB
Notification: Performance of NFTyping.typeComponents: time 0.9699/3, allocations: 22.26 MB / 2.236 GB, free: 10.59 MB / 1.623 GB
Notification: Performance of NFTyping.typeBindings: time 0.1081/3.108, allocations: 38.55 MB / 2.273 GB, free: 10.21 MB / 1.623 GB
Notification: Performance of NFTyping.typeClassSections: time 0.0665/3.175, allocations: 28.85 MB / 2.302 GB, free: 9.68 MB / 1.623 GB
Notification: Performance of NFFlatten.flatten: time 0.212/3.387, allocations: 202.6 MB / 2.499 GB, free: 8.191 MB / 1.654 GB
Notification: Performance of NFFlatten.resolveConnections: time 0.1096/3.497, allocations: 47.76 MB / 2.546 GB, free: 10.05 MB / 1.701 GB
Notification: Performance of NFEvalConstants.evaluate: time 0.1552/3.652, allocations: 80.11 MB / 2.624 GB, free: 0.7656 MB / 1.764 GB
Notification: Performance of NFSimplifyModel.simplify: time 0.08977/3.742, allocations: 54.42 MB / 2.677 GB, free: 14.89 MB / 1.826 GB
Notification: Performance of NFPackage.collectConstants: time 0.02668/3.768, allocations: 7.714 MB / 2.685 GB, free: 7.176 MB / 1.826 GB
Notification: Performance of NFFlatten.collectFunctions: time 0.07893/3.847, allocations: 31.58 MB / 2.716 GB, free: 10.89 MB / 1.857 GB
Notification: Performance of combineBinaries: time 0.1919/4.039, allocations: 152.9 MB / 2.865 GB, free: 8.98 MB / 1.998 GB
Notification: Performance of replaceArrayConstructors: time 0.09249/4.132, allocations: 81.79 MB / 2.945 GB, free: 10.85 MB / 2.076 GB
Notification: Performance of NFVerifyModel.verify: time 0.03169/4.163, allocations: 3.958 MB / 2.949 GB, free: 6.891 MB / 2.076 GB
Notification: Performance of FrontEnd: time 0.01121/4.174, allocations: 1.329 MB / 2.95 GB, free: 5.84 MB / 2.076 GB
Error: Internal error NBackendDAE.lowerVariable failed for protected final parameter Real[3, 1, ({{2}, {4}, {2}})[$conPar1, $lay1]] zonAHUCon.sinZonFlo.flo.conPar.opa.lay.CInv = {{1.0 / zonAHUCon.sinZonFlo.flo.conPar[$conPar1].opa.lay[$lay1].C[i] for i in 1:({{2}, {4}, {2}})[$conPar1, $lay1]} for $lay1 in 1:1, $conPar1 in 1:3}
"
[Timeout remaining time 296]
[Calling sys.exit(0), Time elapsed: 9.988754413032439]
Failed to read output from testmodel.py, exit status != 0:
4.198392714024521 4.212052266 0.033848534
Calling exit ...
<OMPython.OMCSessionZMQ object at 0x7f288234efb0>