Running: ./testmodel.py --libraries=/home/hudson/saved_omc/libraries/.openmodelica/libraries --ompython_omhome=/usr Physiolibrary_Physiolibrary.Fluid.Examples.Respiration.conf.json
loadFile("/home/hudson/saved_omc/libraries/.openmodelica/libraries/Chemical 1.4.1/package.mo", uses=false) [Timeout 180]
"Notification: Performance of loadFile(/home/hudson/saved_omc/libraries/.openmodelica/libraries/Chemical 1.4.1/package.mo): time 0.1304/0.1304, allocations: 15.57 MB / 35.17 MB, free: 4.504 MB / 26.18 MB
"
[Timeout remaining time 180]
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.001264/0.001264, allocations: 101.8 kB / 42.73 MB, free: 6.188 MB / 34.91 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.001532/0.001532, allocations: 216.4 kB / 50.43 MB, free: 10.03 MB / 34.91 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.494/1.494, allocations: 230.6 MB / 288.6 MB, free: 6.41 MB / 206.1 MB
"
[Timeout remaining time 178]
loadFile("/home/hudson/saved_omc/libraries/.openmodelica/libraries/Physiolibrary 3.0.0/package.mo", uses=false) [Timeout 180]
"Notification: Performance of loadFile(/home/hudson/saved_omc/libraries/.openmodelica/libraries/Physiolibrary 3.0.0/package.mo): time 0.1364/0.1364, allocations: 23.73 MB / 373.2 MB, free: 2.98 MB / 286.1 MB
"
[Timeout remaining time 180]
Using package Physiolibrary with version 3.0.0 (/home/hudson/saved_omc/libraries/.openmodelica/libraries/Physiolibrary 3.0.0/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)
Using package Chemical with version 1.4.1 (/home/hudson/saved_omc/libraries/.openmodelica/libraries/Chemical 1.4.1/package.mo)
Running command: translateModel(Physiolibrary.Fluid.Examples.Respiration,tolerance=1e-05,outputFormat="empty",numberOfIntervals=2500,variableFilter="",fileNamePrefix="Physiolibrary_Physiolibrary.Fluid.Examples.Respiration")
translateModel(Physiolibrary.Fluid.Examples.Respiration,tolerance=1e-05,outputFormat="empty",numberOfIntervals=2500,variableFilter="",fileNamePrefix="Physiolibrary_Physiolibrary.Fluid.Examples.Respiration") [Timeout 660]
"Notification: Chemical requested package Modelica of version 4.0.0. Modelica 4.1.0 is used instead which states that it is fully compatible without conversion script needed.
Notification: Physiolibrary requested package Modelica of version 4.0.0. Modelica 4.1.0 is used instead which states that it is fully compatible without conversion script needed.
Notification: Physiolibrary requested package Complex of version 4.0.0. Complex 4.1.0 is used instead which states that it is fully compatible without conversion script needed.
Warning: Requested package Chemical of version 1.4.0, but this package was already loaded with version 1.4.1. There are no conversion annotations and 1.4.0 is older than 1.4.1, so the libraries are probably incompatible.
Notification: Performance of FrontEnd - loaded program: time 0.003516/0.003516, allocations: 126.5 kB / 0.5061 GB, free: 14.44 MB / 366.1 MB
Notification: Performance of FrontEnd - Absyn->SCode: time 0.2914/0.295, allocations: 63.85 MB / 0.5685 GB, free: 14.37 MB / 398.1 MB
Notification: Performance of NFInst.instantiate(Physiolibrary.Fluid.Examples.Respiration): time 0.1734/0.4684, allocations: 150 MB / 0.715 GB, free: 7.812 MB / 0.5294 GB
Notification: Performance of NFInst.instExpressions: time 0.4185/0.8869, allocations: 79.03 MB / 0.7922 GB, free: 15.62 MB / 0.545 GB
Notification: Performance of NFInst.updateImplicitVariability: time 0.002756/0.8897, allocations: 80.88 kB / 0.7923 GB, free: 15.62 MB / 0.545 GB
Notification: Performance of NFTyping.typeComponents: time 0.004258/0.8939, allocations: 1.517 MB / 0.7937 GB, free: 15.61 MB / 0.545 GB
Notification: Performance of NFTyping.typeBindings: time 0.02078/0.9147, allocations: 8.848 MB / 0.8024 GB, free: 15.25 MB / 0.545 GB
Notification: Performance of NFTyping.typeClassSections: time 0.02831/0.943, allocations: 10.96 MB / 0.8131 GB, free: 10.07 MB / 0.545 GB
Notification: Performance of NFFlatten.flatten: time 0.009109/0.9521, allocations: 7.009 MB / 0.8199 GB, free: 7.844 MB / 0.545 GB
Notification: Performance of NFFlatten.resolveConnections: time 0.004567/0.9567, allocations: 2.689 MB / 0.8226 GB, free: 6.234 MB / 0.545 GB
Notification: Performance of NFEvalConstants.evaluate: time 0.02383/0.9805, allocations: 10.9 MB / 0.8332 GB, free: 14.19 MB / 0.5606 GB
Notification: Performance of NFSimplifyModel.simplify: time 0.02153/1.002, allocations: 5.668 MB / 0.8387 GB, free: 9.23 MB / 0.5606 GB
Notification: Performance of NFPackage.collectConstants: time 0.001513/1.004, allocations: 443.9 kB / 0.8391 GB, free: 8.797 MB / 0.5606 GB
Notification: Performance of NFFlatten.collectFunctions: time 0.03063/1.034, allocations: 11.36 MB / 0.8502 GB, free: 13.95 MB / 0.5762 GB
Notification: Performance of NFScalarize.scalarize: time 0.005036/1.039, allocations: 3.647 MB / 0.8538 GB, free: 10.39 MB / 0.5762 GB
Notification: Performance of NFVerifyModel.verify: time 0.005874/1.045, allocations: 3.494 MB / 0.8572 GB, free: 6.984 MB / 0.5762 GB
Notification: Performance of NFConvertDAE.convert: time 0.04614/1.091, allocations: 21.48 MB / 0.8782 GB, free: 2.883 MB / 0.5919 GB
Notification: Performance of FrontEnd - DAE generated: time 4.599e-06/1.091, allocations: 0 / 0.8782 GB, free: 2.883 MB / 0.5919 GB
Notification: Performance of FrontEnd: time 1.483e-06/1.091, allocations: 0 / 0.8782 GB, free: 2.883 MB / 0.5919 GB
Notification: Performance of Transformations before backend: time 0.0002369/1.091, allocations: 0 / 0.8782 GB, free: 2.883 MB / 0.5919 GB
Notification: Model statistics after passing the front-end and creating the data structures used by the back-end:
 * Number of equations: 869
 * Number of variables: 869
Notification: Performance of Generate backend data structure: time 9.893/10.98, allocations: 1.534 GB / 2.412 GB, free: 93.04 MB / 0.7012 GB
Notification: Performance of prepare preOptimizeDAE: time 3.733e-05/10.98, allocations: 8.031 kB / 2.412 GB, free: 93.03 MB / 0.7012 GB
Notification: Performance of preOpt normalInlineFunction (simulation): time 0.005525/10.99, allocations: 1.339 MB / 2.414 GB, free: 91.69 MB / 0.7012 GB
Notification: Performance of preOpt evaluateParameters (simulation): time 0.02069/11.01, allocations: 20.39 MB / 2.434 GB, free: 71.84 MB / 0.7012 GB
Notification: Performance of preOpt simplifyIfEquations (simulation): time 0.0001751/11.01, allocations: 262.1 kB / 2.434 GB, free: 71.59 MB / 0.7012 GB
Notification: Performance of preOpt expandDerOperator (simulation): time 0.001667/11.01, allocations: 316 kB / 2.434 GB, free: 71.28 MB / 0.7012 GB
Notification: Performance of preOpt clockPartitioning (simulation): time 0.0162/11.03, allocations: 11.64 MB / 2.445 GB, free: 59.42 MB / 0.7012 GB
Notification: Performance of preOpt findStateOrder (simulation): time 7.101e-05/11.03, allocations: 23.81 kB / 2.445 GB, free: 59.39 MB / 0.7012 GB
Notification: Performance of preOpt replaceEdgeChange (simulation): time 0.0008894/11.03, allocations: 128 kB / 2.446 GB, free: 59.27 MB / 0.7012 GB
Notification: Performance of preOpt inlineArrayEqn (simulation): time 0.0005151/11.03, allocations: 230 kB / 2.446 GB, free: 59.04 MB / 0.7012 GB
Notification: Performance of preOpt removeEqualRHS (simulation): time 0.02133/11.05, allocations: 15.82 MB / 2.461 GB, free: 43.2 MB / 0.7012 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.06469/11.12, allocations: 37.37 MB / 2.498 GB, free: 5.922 MB / 0.7012 GB
Notification: Performance of preOpt comSubExp (simulation): time 0.2408/11.36, allocations: 7.334 MB / 2.505 GB, free: 284.1 MB / 0.7012 GB
Notification: Performance of preOpt resolveLoops (simulation): time 0.008805/11.37, allocations: 5.659 MB / 2.51 GB, free: 283 MB / 0.7012 GB
Notification: Performance of preOpt evalFunc (simulation): time 0.0237/11.39, allocations: 13.56 MB / 2.524 GB, free: 278.6 MB / 0.7012 GB
Notification: Performance of preOpt encapsulateWhenConditions (simulation): time 3.365e-05/11.39, allocations: 60.23 kB / 2.524 GB, free: 278.5 MB / 0.7012 GB
Notification: Performance of preOpt simplifyInStream (simulation): time 0.00362/11.39, allocations: 0.7776 MB / 2.524 GB, free: 278.4 MB / 0.7012 GB
Notification: Performance of pre-optimization done (n=309): time 9.638e-06/11.39, allocations: 0 / 2.524 GB, free: 278.4 MB / 0.7012 GB
Notification: Performance of matching and sorting (n=309): time 0.03927/11.43, allocations: 20.66 MB / 2.545 GB, free: 270.5 MB / 0.7012 GB
Notification: Performance of inlineWhenForInitialization (initialization): time 3.723e-05/11.43, allocations: 80.95 kB / 2.545 GB, free: 270.4 MB / 0.7012 GB
Notification: Performance of selectInitializationVariablesDAE (initialization): time 0.02324/11.46, allocations: 32.31 MB / 2.576 GB, free: 238.6 MB / 0.7012 GB
Notification: Performance of collectPreVariables (initialization): time 0.001626/11.46, allocations: 76.8 kB / 2.576 GB, free: 238.5 MB / 0.7012 GB
Notification: Performance of collectInitialEqns (initialization): time 0.001529/11.46, allocations: 2.551 MB / 2.579 GB, free: 236.3 MB / 0.7012 GB
Notification: Performance of collectInitialBindings (initialization): time 0.001555/11.46, allocations: 1.263 MB / 2.58 GB, free: 235.2 MB / 0.7012 GB
Notification: Performance of simplifyInitialFunctions (initialization): time 0.005665/11.47, allocations: 4.763 MB / 2.585 GB, free: 230.4 MB / 0.7012 GB
Notification: Performance of setup shared object (initialization): time 3.556e-05/11.47, allocations: 301.1 kB / 2.585 GB, free: 230.1 MB / 0.7012 GB
Notification: Performance of preBalanceInitialSystem (initialization): time 0.02161/11.49, allocations: 29.38 MB / 2.614 GB, free: 200.7 MB / 0.7012 GB
Notification: Performance of partitionIndependentBlocks (initialization): time 0.02445/11.51, allocations: 31.18 MB / 2.644 GB, free: 169.1 MB / 0.7012 GB
Warning: It was not possible to determine if the initialization problem is consistent, because of not evaluable parameters/start values during compile time: leftPleuralSpace.mass = leftPleuralSpace.tm_start (leftPleuralSpace.m_start[1] + leftPleuralSpace.massOffset = leftPleuralSpace.tm_start)
Warning: It was not possible to determine if the initialization problem is consistent, because of not evaluable parameters/start values during compile time: rightPleuralSpace.mass = rightPleuralSpace.tm_start (rightPleuralSpace.m_start[1] + rightPleuralSpace.massOffset = rightPleuralSpace.tm_start)
Error: No system for the symbolic initialization was generated
"
[Timeout remaining time 612]
[Calling sys.exit(0), Time elapsed: 50.918850156944245]
Failed to read output from testmodel.py, exit status != 0:
48.34981815004721 48.358539454 47.264845527
Calling exit ...
<OMPython.OMCSessionZMQ object at 0x7f11acb96fe0>