Running: ./testmodel.py --libraries=/home/hudson/saved_omc/libraries/.openmodelica/libraries --ompython_omhome=/usr Modelica_4.1.0_Modelica.Media.Examples.ReferenceAir.MoistAir2.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.001564/0.001564, allocations: 107 kB / 21.23 MB, free: 0.6406 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.001934/0.001934, allocations: 214 kB / 24.53 MB, free: 3.941 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.523/1.523, allocations: 230.6 MB / 258.3 MB, free: 7.812 MB / 206.1 MB
"
[Timeout remaining time 178]
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: writeFile("Modelica.Media.Examples.ReferenceAir.MoistAir2.mo", OpenModelica.Scripting.instantiateModel(Modelica.Media.Examples.ReferenceAir.MoistAir2))
writeFile("Modelica.Media.Examples.ReferenceAir.MoistAir2.mo", OpenModelica.Scripting.instantiateModel(Modelica.Media.Examples.ReferenceAir.MoistAir2)) [Timeout 660]
"Notification: Performance of FrontEnd - loaded program: time 0.001663/0.001663, allocations: 43.92 kB / 378.5 MB, free: 3.012 MB / 302.1 MB
Notification: Performance of FrontEnd - Absyn->SCode: time 0.3146/0.3163, allocations: 53.37 MB / 431.9 MB, free: 6.688 MB / 334.1 MB
Notification: Performance of NFInst.instantiate(Modelica.Media.Examples.ReferenceAir.MoistAir2): time 0.07488/0.3912, allocations: 58.98 MB / 490.9 MB, free: 11.51 MB / 398.1 MB
Notification: Performance of NFInst.instExpressions: time 0.007491/0.3986, allocations: 4.97 MB / 495.8 MB, free: 6.52 MB / 398.1 MB
Notification: Performance of NFInst.updateImplicitVariability: time 0.0004064/0.3991, allocations: 31.69 kB / 495.9 MB, free: 6.488 MB / 398.1 MB
Notification: Performance of NFTyping.typeComponents: time 0.001035/0.4001, allocations: 330.1 kB / 496.2 MB, free: 6.164 MB / 398.1 MB
Notification: Performance of NFTyping.typeBindings: time 0.001046/0.4011, allocations: 0.5244 MB / 496.7 MB, free: 5.637 MB / 398.1 MB
Notification: Performance of NFTyping.typeClassSections: time 0.02158/0.4227, allocations: 8.287 MB / 0.4932 GB, free: 13.35 MB / 414.1 MB
Notification: Performance of NFFlatten.flatten: time 0.002259/0.425, allocations: 1.571 MB / 0.4947 GB, free: 11.78 MB / 414.1 MB
Notification: Performance of NFFlatten.resolveConnections: time 0.0003232/0.4253, allocations: 149.4 kB / 0.4948 GB, free: 11.62 MB / 414.1 MB
Notification: Performance of NFEvalConstants.evaluate: time 0.001181/0.4265, allocations: 0.6697 MB / 0.4955 GB, free: 10.95 MB / 414.1 MB
Notification: Performance of NFSimplifyModel.simplify: time 0.0009195/0.4274, allocations: 0.5917 MB / 0.4961 GB, free: 10.36 MB / 414.1 MB
Notification: Performance of NFPackage.collectConstants: time 0.0001511/0.4276, allocations: 80 kB / 0.4961 GB, free: 10.28 MB / 414.1 MB
Notification: Performance of NFFlatten.collectFunctions: time 0.01904/0.4466, allocations: 10.08 MB / 0.506 GB, free: 192 kB / 414.1 MB
Notification: Performance of NFScalarize.scalarize: time 0.0005278/0.4471, allocations: 307.2 kB / 0.5063 GB, free: 15.89 MB / 430.1 MB
Notification: Performance of NFTyping.typeComponents: time 0.01821/0.4653, allocations: 9.763 MB / 0.5158 GB, free: 6.387 MB / 430.1 MB
Notification: Performance of NFTyping.typeBindings: time 3.457e-05/0.4654, allocations: 3.938 kB / 0.5158 GB, free: 6.383 MB / 430.1 MB
Notification: Performance of NFTyping.typeClassSections: time 1.903e-06/0.4654, allocations: 4 kB / 0.5158 GB, free: 6.379 MB / 430.1 MB
Notification: Performance of NFTyping.typeComponents: time 0.000175/0.4655, allocations: 109 kB / 0.5159 GB, free: 6.273 MB / 430.1 MB
Notification: Performance of NFTyping.typeBindings: time 2.604e-05/0.4656, allocations: 19.91 kB / 0.5159 GB, free: 6.254 MB / 430.1 MB
Notification: Performance of NFTyping.typeClassSections: time 6.82e-07/0.4656, allocations: 0 / 0.5159 GB, free: 6.254 MB / 430.1 MB
Notification: Performance of NFTyping.typeComponents: time 0.0001497/0.4657, allocations: 109 kB / 0.516 GB, free: 6.145 MB / 430.1 MB
Notification: Performance of NFTyping.typeBindings: time 1.794e-05/0.4657, allocations: 7.984 kB / 0.516 GB, free: 6.137 MB / 430.1 MB
Notification: Performance of NFTyping.typeClassSections: time 6.31e-07/0.4657, allocations: 0 / 0.516 GB, free: 6.137 MB / 430.1 MB
Notification: Performance of NFTyping.typeComponents: time 0.0001609/0.4659, allocations: 109 kB / 0.5161 GB, free: 6.027 MB / 430.1 MB
Notification: Performance of NFTyping.typeBindings: time 2.291e-05/0.4659, allocations: 11.92 kB / 0.5162 GB, free: 6.016 MB / 430.1 MB
Notification: Performance of NFTyping.typeClassSections: time 7.01e-07/0.4659, allocations: 4 kB / 0.5162 GB, free: 6.012 MB / 430.1 MB
Notification: Performance of NFTyping.typeComponents: time 7.912e-05/0.466, allocations: 49.17 kB / 0.5162 GB, free: 5.965 MB / 430.1 MB
Notification: Performance of NFTyping.typeBindings: time 1.383e-06/0.466, allocations: 3.938 kB / 0.5162 GB, free: 5.961 MB / 430.1 MB
Notification: Performance of NFTyping.typeClassSections: time 5.81e-07/0.466, allocations: 0 / 0.5162 GB, free: 5.961 MB / 430.1 MB
Notification: Performance of NFTyping.typeComponents: time 0.0001763/0.4662, allocations: 115.5 kB / 0.5163 GB, free: 5.848 MB / 430.1 MB
Notification: Performance of NFTyping.typeBindings: time 1.273e-05/0.4662, allocations: 3.938 kB / 0.5163 GB, free: 5.844 MB / 430.1 MB
Notification: Performance of NFTyping.typeClassSections: time 1.001e-06/0.4662, allocations: 3.938 kB / 0.5163 GB, free: 5.84 MB / 430.1 MB
Notification: Performance of NFTyping.typeComponents: time 0.0001757/0.4664, allocations: 125.6 kB / 0.5165 GB, free: 5.719 MB / 430.1 MB
Notification: Performance of NFTyping.typeBindings: time 1.3e-05/0.4664, allocations: 7.922 kB / 0.5165 GB, free: 5.711 MB / 430.1 MB
Notification: Performance of NFTyping.typeClassSections: time 8.61e-07/0.4664, allocations: 4 kB / 0.5165 GB, free: 5.707 MB / 430.1 MB
Notification: Performance of NFTyping.typeComponents: time 7.998e-05/0.4665, allocations: 57.2 kB / 0.5165 GB, free: 5.652 MB / 430.1 MB
Notification: Performance of NFTyping.typeBindings: time 4.769e-06/0.4665, allocations: 3.938 kB / 0.5165 GB, free: 5.648 MB / 430.1 MB
Notification: Performance of NFTyping.typeClassSections: time 5.21e-07/0.4665, allocations: 0 / 0.5165 GB, free: 5.648 MB / 430.1 MB
Notification: Performance of NFTyping.typeComponents: time 0.0001257/0.4666, allocations: 91.75 kB / 0.5166 GB, free: 5.559 MB / 430.1 MB
Notification: Performance of NFTyping.typeBindings: time 1.787e-05/0.4666, allocations: 7.938 kB / 0.5166 GB, free: 5.551 MB / 430.1 MB
Notification: Performance of NFTyping.typeClassSections: time 6.01e-07/0.4666, allocations: 0 / 0.5166 GB, free: 5.551 MB / 430.1 MB
Notification: Performance of NFTyping.typeComponents: time 0.0001977/0.4668, allocations: 164.8 kB / 0.5168 GB, free: 5.391 MB / 430.1 MB
Notification: Performance of NFTyping.typeBindings: time 1.672e-05/0.4668, allocations: 7.922 kB / 0.5168 GB, free: 5.383 MB / 430.1 MB
Notification: Performance of NFTyping.typeClassSections: time 9.71e-07/0.4668, allocations: 0 / 0.5168 GB, free: 5.383 MB / 430.1 MB
Notification: Performance of NFTyping.typeComponents: time 0.0001615/0.467, allocations: 129.5 kB / 0.5169 GB, free: 5.258 MB / 430.1 MB
Notification: Performance of NFTyping.typeBindings: time 1.276e-05/0.467, allocations: 7.922 kB / 0.5169 GB, free: 5.25 MB / 430.1 MB
Notification: Performance of NFTyping.typeClassSections: time 8.31e-07/0.467, allocations: 4 kB / 0.5169 GB, free: 5.246 MB / 430.1 MB
Notification: Performance of NFTyping.typeComponents: time 0.0001426/0.4671, allocations: 108.9 kB / 0.517 GB, free: 5.141 MB / 430.1 MB
Notification: Performance of NFTyping.typeBindings: time 1.258e-05/0.4672, allocations: 7.922 kB / 0.517 GB, free: 5.133 MB / 430.1 MB
Notification: Performance of NFTyping.typeClassSections: time 7.62e-07/0.4672, allocations: 0 / 0.517 GB, free: 5.133 MB / 430.1 MB
Notification: Performance of NFVerifyModel.verify: time 0.004247/0.4714, allocations: 2.116 MB / 0.5191 GB, free: 3.031 MB / 430.1 MB
Notification: Performance of NFConvertDAE.convert: time 0.01499/0.4864, allocations: 5.935 MB / 0.5249 GB, free: 13.08 MB / 446.1 MB
Notification: Performance of FrontEnd - DAE generated: time 8.215e-06/0.4864, allocations: 0 / 0.5249 GB, free: 13.08 MB / 446.1 MB
Notification: Performance of runFrontEnd: time 1.803e-06/0.4864, allocations: 3.938 kB / 0.5249 GB, free: 13.08 MB / 446.1 MB
Notification: Performance of FrontEnd - loaded program: time 0.001728/0.001728, allocations: 51.92 kB / 0.5249 GB, free: 13.03 MB / 446.1 MB
Notification: Performance of FrontEnd - Absyn->SCode: time 0.2588/0.2605, allocations: 53.35 MB / 0.577 GB, free: 116.4 MB / 446.1 MB
Notification: Performance of NFInst.instantiate(Modelica.Media.Examples.ReferenceAir.MoistAir2): time 0.04686/0.3074, allocations: 58.98 MB / 0.6346 GB, free: 57.36 MB / 446.1 MB
Notification: Performance of NFInst.instExpressions: time 0.004689/0.3121, allocations: 4.967 MB / 0.6395 GB, free: 52.38 MB / 446.1 MB
Notification: Performance of NFInst.updateImplicitVariability: time 0.0002961/0.3124, allocations: 27.75 kB / 0.6395 GB, free: 52.35 MB / 446.1 MB
Notification: Performance of NFTyping.typeComponents: time 0.0006465/0.313, allocations: 338 kB / 0.6398 GB, free: 52.02 MB / 446.1 MB
Notification: Performance of NFTyping.typeBindings: time 0.0006302/0.3137, allocations: 0.5244 MB / 0.6404 GB, free: 51.49 MB / 446.1 MB
Notification: Performance of NFTyping.typeClassSections: time 0.0155/0.3292, allocations: 8.287 MB / 0.6485 GB, free: 43.21 MB / 446.1 MB
Notification: Performance of NFFlatten.flatten: time 0.001223/0.3304, allocations: 1.575 MB / 0.65 GB, free: 41.63 MB / 446.1 MB
Notification: Performance of NFFlatten.resolveConnections: time 0.0001598/0.3305, allocations: 157.2 kB / 0.6501 GB, free: 41.47 MB / 446.1 MB
Notification: Performance of NFEvalConstants.evaluate: time 0.0006126/0.3312, allocations: 0.6658 MB / 0.6508 GB, free: 40.8 MB / 446.1 MB
Notification: Performance of NFSimplifyModel.simplify: time 0.0004935/0.3316, allocations: 0.5878 MB / 0.6514 GB, free: 40.21 MB / 446.1 MB
Notification: Performance of NFPackage.collectConstants: time 9.354e-05/0.3317, allocations: 80 kB / 0.6514 GB, free: 40.13 MB / 446.1 MB
Notification: Performance of NFFlatten.collectFunctions: time 0.01321/0.345, allocations: 10.08 MB / 0.6613 GB, free: 30.04 MB / 446.1 MB
Notification: Performance of NFScalarize.scalarize: time 0.0003345/0.3453, allocations: 319.2 kB / 0.6616 GB, free: 29.73 MB / 446.1 MB
Notification: Performance of NFTyping.typeComponents: time 0.01328/0.3586, allocations: 9.74 MB / 0.6711 GB, free: 20.29 MB / 446.1 MB
Notification: Performance of NFTyping.typeBindings: time 3.113e-05/0.3586, allocations: 15.92 kB / 0.6711 GB, free: 20.27 MB / 446.1 MB
Notification: Performance of NFTyping.typeClassSections: time 2.264e-06/0.3586, allocations: 0 / 0.6711 GB, free: 20.27 MB / 446.1 MB
Notification: Performance of NFTyping.typeComponents: time 0.0001219/0.3587, allocations: 105.1 kB / 0.6712 GB, free: 20.17 MB / 446.1 MB
Notification: Performance of NFTyping.typeBindings: time 1.575e-05/0.3587, allocations: 11.97 kB / 0.6712 GB, free: 20.16 MB / 446.1 MB
Notification: Performance of NFTyping.typeClassSections: time 7.11e-07/0.3587, allocations: 0 / 0.6712 GB, free: 20.16 MB / 446.1 MB
Notification: Performance of NFTyping.typeComponents: time 0.0001014/0.3588, allocations: 113 kB / 0.6713 GB, free: 20.04 MB / 446.1 MB
Notification: Performance of NFTyping.typeBindings: time 1.58e-05/0.3589, allocations: 15.91 kB / 0.6713 GB, free: 20.03 MB / 446.1 MB
Notification: Performance of NFTyping.typeClassSections: time 6.51e-07/0.3589, allocations: 0 / 0.6713 GB, free: 20.03 MB / 446.1 MB
Notification: Performance of NFTyping.typeComponents: time 9.999e-05/0.359, allocations: 109 kB / 0.6715 GB, free: 19.92 MB / 446.1 MB
Notification: Performance of NFTyping.typeBindings: time 1.442e-05/0.359, allocations: 11.92 kB / 0.6715 GB, free: 19.91 MB / 446.1 MB
Notification: Performance of NFTyping.typeClassSections: time 6.31e-07/0.359, allocations: 0 / 0.6715 GB, free: 19.91 MB / 446.1 MB
Notification: Performance of NFTyping.typeComponents: time 5.913e-05/0.359, allocations: 49.19 kB / 0.6715 GB, free: 19.86 MB / 446.1 MB
Notification: Performance of NFTyping.typeBindings: time 1.192e-06/0.359, allocations: 0 / 0.6715 GB, free: 19.86 MB / 446.1 MB
Notification: Performance of NFTyping.typeClassSections: time 5.01e-07/0.359, allocations: 0 / 0.6715 GB, free: 19.86 MB / 446.1 MB
Notification: Performance of NFTyping.typeComponents: time 0.000138/0.3592, allocations: 119.5 kB / 0.6716 GB, free: 19.74 MB / 446.1 MB
Notification: Performance of NFTyping.typeBindings: time 1.151e-05/0.3592, allocations: 3.984 kB / 0.6716 GB, free: 19.74 MB / 446.1 MB
Notification: Performance of NFTyping.typeClassSections: time 8.82e-07/0.3592, allocations: 0 / 0.6716 GB, free: 19.74 MB / 446.1 MB
Notification: Performance of NFTyping.typeComponents: time 0.0001023/0.3593, allocations: 117.5 kB / 0.6717 GB, free: 19.62 MB / 446.1 MB
Notification: Performance of NFTyping.typeBindings: time 1.047e-05/0.3593, allocations: 7.922 kB / 0.6717 GB, free: 19.62 MB / 446.1 MB
Notification: Performance of NFTyping.typeClassSections: time 8.51e-07/0.3593, allocations: 4 kB / 0.6718 GB, free: 19.61 MB / 446.1 MB
Notification: Performance of NFTyping.typeComponents: time 6.16e-05/0.3594, allocations: 69.19 kB / 0.6718 GB, free: 19.55 MB / 446.1 MB
Notification: Performance of NFTyping.typeBindings: time 3.306e-06/0.3594, allocations: 3.938 kB / 0.6718 GB, free: 19.54 MB / 446.1 MB
Notification: Performance of NFTyping.typeClassSections: time 4.81e-07/0.3594, allocations: 0 / 0.6718 GB, free: 19.54 MB / 446.1 MB
Notification: Performance of NFTyping.typeComponents: time 7.13e-05/0.3594, allocations: 75.83 kB / 0.6719 GB, free: 19.47 MB / 446.1 MB
Notification: Performance of NFTyping.typeBindings: time 1.7e-05/0.3594, allocations: 19.91 kB / 0.6719 GB, free: 19.45 MB / 446.1 MB
Notification: Performance of NFTyping.typeClassSections: time 6.31e-07/0.3595, allocations: 0 / 0.6719 GB, free: 19.45 MB / 446.1 MB
Notification: Performance of NFTyping.typeComponents: time 0.0001333/0.3596, allocations: 156.7 kB / 0.6721 GB, free: 19.3 MB / 446.1 MB
Notification: Performance of NFTyping.typeBindings: time 1.375e-05/0.3596, allocations: 15.91 kB / 0.6721 GB, free: 19.28 MB / 446.1 MB
Notification: Performance of NFTyping.typeClassSections: time 1.002e-06/0.3596, allocations: 0 / 0.6721 GB, free: 19.28 MB / 446.1 MB
Notification: Performance of NFTyping.typeComponents: time 0.0001026/0.3597, allocations: 140.1 kB / 0.6722 GB, free: 19.15 MB / 446.1 MB
Notification: Performance of NFTyping.typeBindings: time 8.125e-06/0.3597, allocations: 0 / 0.6722 GB, free: 19.15 MB / 446.1 MB
Notification: Performance of NFTyping.typeClassSections: time 7.42e-07/0.3597, allocations: 3.938 kB / 0.6722 GB, free: 19.14 MB / 446.1 MB
Notification: Performance of NFTyping.typeComponents: time 8.959e-05/0.3598, allocations: 113 kB / 0.6723 GB, free: 19.04 MB / 446.1 MB
Notification: Performance of NFTyping.typeBindings: time 8.616e-06/0.3598, allocations: 3.938 kB / 0.6723 GB, free: 19.03 MB / 446.1 MB
Notification: Performance of NFTyping.typeClassSections: time 7.62e-07/0.3598, allocations: 0 / 0.6723 GB, free: 19.03 MB / 446.1 MB
Notification: Performance of NFVerifyModel.verify: time 0.002511/0.3623, allocations: 2.11 MB / 0.6744 GB, free: 16.93 MB / 446.1 MB
Notification: Performance of NFConvertDAE.convert: time 0.01086/0.3732, allocations: 5.935 MB / 0.6802 GB, free: 10.98 MB / 446.1 MB
Notification: Performance of FrontEnd - DAE generated: time 4.759e-06/0.3732, allocations: 7.938 kB / 0.6802 GB, free: 10.98 MB / 446.1 MB
Notification: Performance of runFrontEnd: time 1.613e-06/0.3732, allocations: 0 / 0.6802 GB, free: 10.98 MB / 446.1 MB
"
[Timeout remaining time 659]
(rm -f Modelica_4.1.0_Modelica.Media.Examples.ReferenceAir.MoistAir2.pipe ; mkfifo Modelica_4.1.0_Modelica.Media.Examples.ReferenceAir.MoistAir2.pipe ; head -c 1048576 < Modelica_4.1.0_Modelica.Media.Examples.ReferenceAir.MoistAir2.pipe >> ../files/Modelica_4.1.0_Modelica.Media.Examples.ReferenceAir.MoistAir2.sim & /usr/bin/julia Modelica.Media.Examples.ReferenceAir.MoistAir2_test.jl > Modelica_4.1.0_Modelica.Media.Examples.ReferenceAir.MoistAir2.pipe 2>&1) [Timeout 504.0]
[Calling os._exit(0), Time elapsed: 36.86431547673419]
Failed to read output from testmodel.py, exit status != 0:
['time', 'volume.medium.T', 'volume.medium.Xi[1]', 'volume.medium.p', 'volume1.medium.T', 'volume1.medium.Xi[1]', 'volume1.medium.p']
0.8675492769107223 -1.0 -1.0
Calling exit ...
<OMPython.OMCSessionZMQ object at 0x7f5bd94f6f20>