Running: ./testmodel.py --libraries=/home/hudson/saved_omc/libraries/.openmodelica/libraries --ompython_omhome=/usr Chemical_master_Chemical.Examples.SimpleReactionInSolution.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.001465/0.001465, allocations: 83.03 kB / 19.18 MB, free: 2.516 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.00166/0.00166, allocations: 161.1 kB / 22.46 MB, free: 5.375 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.476/1.476, allocations: 177.2 MB / 202.8 MB, free: 9.168 MB / 190.1 MB
"
[Timeout remaining time 178]
loadFile("/home/hudson/saved_omc/libraries/.openmodelica/libraries/Chemical master/package.mo", uses=false) [Timeout 180]
"Notification: Performance of loadFile(/home/hudson/saved_omc/libraries/.openmodelica/libraries/Chemical master/package.mo): time 0.1337/0.1337, allocations: 17.45 MB / 276.6 MB, free: 15.21 MB / 270.1 MB
"
[Timeout remaining time 180]
Using package Chemical with version 2.0.1 (/home/hudson/saved_omc/libraries/.openmodelica/libraries/Chemical master/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(Chemical.Examples.SimpleReactionInSolution,tolerance=1e-06,outputFormat="empty",numberOfIntervals=2500,variableFilter="",fileNamePrefix="Chemical_master_Chemical.Examples.SimpleReactionInSolution")
translateModel(Chemical.Examples.SimpleReactionInSolution,tolerance=1e-06,outputFormat="empty",numberOfIntervals=2500,variableFilter="",fileNamePrefix="Chemical_master_Chemical.Examples.SimpleReactionInSolution") [Timeout 660]
"Notification: Performance of FrontEnd - loaded program: time 2.003e-06/2.003e-06, allocations: 0 / 412.1 MB, free: 4.301 MB / 334.1 MB
Notification: Performance of FrontEnd - Absyn->SCode: time 3.047e-05/3.247e-05, allocations: 6.281 kB / 412.1 MB, free: 4.293 MB / 334.1 MB
[/home/hudson/saved_omc/libraries/.openmodelica/libraries/Chemical master/Boundaries.mo:1361:7-1361:76:writable] Warning: An inner declaration for outer component dropOfCommons could not be found and was automatically generated.
[/home/hudson/saved_omc/libraries/.openmodelica/libraries/Chemical master/Boundaries.mo:1361:7-1361:76:writable] Notification: The diagnostics message for the missing inner is: 
Your model is using an outer \"dropOfCommons\" component but
an inner \"dropOfCommons\" component is not defined.
Use Chemical.DropOfCommons in your model
to specify system properties.
Notification: Performance of NFInst.instantiate(Chemical.Examples.SimpleReactionInSolution): time 0.04291/0.04294, allocations: 30.31 MB / 442.4 MB, free: 6.094 MB / 366.1 MB
Notification: Performance of NFInst.instExpressions: time 0.2285/0.2715, allocations: 9.603 MB / 452 MB, free: 31.4 MB / 366.1 MB
Notification: Performance of NFInst.updateImplicitVariability: time 0.002325/0.2738, allocations: 66.56 kB / 452.1 MB, free: 31.4 MB / 366.1 MB
Notification: Performance of NFTyping.typeComponents: time 0.005977/0.2798, allocations: 1.841 MB / 453.9 MB, free: 31.33 MB / 366.1 MB
Notification: Performance of NFTyping.typeBindings: time 0.00446/0.2842, allocations: 1.351 MB / 455.3 MB, free: 30.98 MB / 366.1 MB
Notification: Performance of NFTyping.typeClassSections: time 0.008278/0.2925, allocations: 3.976 MB / 459.2 MB, free: 30.2 MB / 366.1 MB
[/home/hudson/saved_omc/libraries/.openmodelica/libraries/Chemical master/Interfaces.mo:1332:3-1332:55:writable] Warning: Parameter reaction.nextProducts[1].data.MM has no value, and is fixed during initialization (fixed=true), using available start value (start=0.0) as default value.
[/home/hudson/saved_omc/libraries/.openmodelica/libraries/Chemical master/Interfaces.mo:1333:3-1333:87:writable] Warning: Parameter reaction.nextProducts[1].data.Hf has no value, and is fixed during initialization (fixed=true), using available start value (start=0.0) as default value.
[/home/hudson/saved_omc/libraries/.openmodelica/libraries/Chemical master/Interfaces.mo:1334:3-1334:81:writable] Warning: Parameter reaction.nextProducts[1].data.H0 has no value, and is fixed during initialization (fixed=true), using available start value (start=0.0) as default value.
[/home/hudson/saved_omc/libraries/.openmodelica/libraries/Chemical master/Interfaces.mo:1336:3-1336:82:writable] Warning: Parameter reaction.nextProducts[1].data.alow has no value, and is fixed during initialization (fixed=true), using available start value (start=fill(0.0, 7)) as default value.
[/home/hudson/saved_omc/libraries/.openmodelica/libraries/Chemical master/Interfaces.mo:1337:3-1337:79:writable] Warning: Parameter reaction.nextProducts[1].data.blow has no value, and is fixed during initialization (fixed=true), using available start value (start=fill(0.0, 3)) as default value.
[/home/hudson/saved_omc/libraries/.openmodelica/libraries/Chemical master/Interfaces.mo:1338:3-1338:84:writable] Warning: Parameter reaction.nextProducts[1].data.ahigh has no value, and is fixed during initialization (fixed=true), using available start value (start=fill(0.0, 7)) as default value.
[/home/hudson/saved_omc/libraries/.openmodelica/libraries/Chemical master/Interfaces.mo:1339:3-1339:81:writable] Warning: Parameter reaction.nextProducts[1].data.bhigh has no value, and is fixed during initialization (fixed=true), using available start value (start=fill(0.0, 3)) as default value.
[/home/hudson/saved_omc/libraries/.openmodelica/libraries/Chemical master/Interfaces.mo:1341:3-1342:83:writable] Warning: Parameter reaction.nextProducts[1].data.z has no value, and is fixed during initialization (fixed=true), using available start value (start=0.0) as default value.
[/home/hudson/saved_omc/libraries/.openmodelica/libraries/Chemical master/Interfaces.mo:1344:3-1344:89:writable] Warning: Parameter reaction.nextProducts[1].data.phase has no value, and is fixed during initialization (fixed=true), using available start value (start=Chemical.Interfaces.Phase.Gas) as default value.
[/home/hudson/saved_omc/libraries/.openmodelica/libraries/Chemical master/Interfaces.mo:1347:3-1347:140:writable] Warning: Parameter reaction.nextProducts[1].data.VmBase has no value, and is fixed during initialization (fixed=true), using available start value (start=0.0) as default value.
[/home/hudson/saved_omc/libraries/.openmodelica/libraries/Chemical master/Interfaces.mo:1348:3-1348:137:writable] Warning: Parameter reaction.nextProducts[1].data.VmExcess has no value, and is fixed during initialization (fixed=true), using available start value (start=0.0) as default value.
Notification: Performance of NFFlatten.flatten: time 0.005473/0.298, allocations: 2.913 MB / 462.2 MB, free: 28.83 MB / 366.1 MB
Notification: Performance of NFFlatten.resolveConnections: time 0.001051/0.299, allocations: 0.5318 MB / 462.7 MB, free: 28.59 MB / 366.1 MB
Notification: Performance of NFEvalConstants.evaluate: time 0.003062/0.3021, allocations: 1.642 MB / 464.3 MB, free: 27.93 MB / 366.1 MB
Notification: Performance of NFSimplifyModel.simplify: time 0.0024/0.3045, allocations: 1.236 MB / 465.6 MB, free: 27.61 MB / 366.1 MB
Notification: Performance of NFPackage.collectConstants: time 0.0004977/0.305, allocations: 247.9 kB / 465.8 MB, free: 27.61 MB / 366.1 MB
Notification: Performance of NFFlatten.collectFunctions: time 0.005927/0.3109, allocations: 1.986 MB / 467.8 MB, free: 27.25 MB / 366.1 MB
Notification: Performance of NFScalarize.scalarize: time 0.0009369/0.3118, allocations: 0.8473 MB / 468.6 MB, free: 26.8 MB / 366.1 MB
Notification: Performance of NFVerifyModel.verify: time 0.001784/0.3136, allocations: 0.916 MB / 469.6 MB, free: 26.42 MB / 366.1 MB
Notification: Performance of NFConvertDAE.convert: time 0.008472/0.3221, allocations: 5.205 MB / 474.8 MB, free: 23.25 MB / 366.1 MB
Notification: Performance of FrontEnd - DAE generated: time 4.859e-06/0.3221, allocations: 0 / 474.8 MB, free: 23.25 MB / 366.1 MB
Notification: Performance of FrontEnd: time 1.423e-06/0.3221, allocations: 2.656 kB / 474.8 MB, free: 23.25 MB / 366.1 MB
Notification: Performance of Transformations before backend: time 9.752e-05/0.3222, allocations: 3.984 kB / 474.8 MB, free: 23.25 MB / 366.1 MB
Notification: Model statistics after passing the front-end and creating the data structures used by the back-end:
 * Number of equations: 751
 * Number of variables: 751
Notification: Performance of Generate backend data structure: time 0.006365/0.3286, allocations: 3.414 MB / 478.2 MB, free: 20.84 MB / 366.1 MB
Notification: Performance of prepare preOptimizeDAE: time 4.223e-05/0.3286, allocations: 8.406 kB / 478.2 MB, free: 20.84 MB / 366.1 MB
Notification: Performance of preOpt normalInlineFunction (simulation): time 0.002213/0.3308, allocations: 0.7312 MB / 478.9 MB, free: 20.46 MB / 366.1 MB
Notification: Performance of preOpt evaluateParameters (simulation): time 0.002164/0.333, allocations: 1.519 MB / 480.4 MB, free: 19.27 MB / 366.1 MB
Notification: Performance of preOpt simplifyIfEquations (simulation): time 0.0002878/0.3333, allocations: 416.2 kB / 480.8 MB, free: 18.91 MB / 366.1 MB
Notification: Performance of preOpt expandDerOperator (simulation): time 0.0003187/0.3336, allocations: 239.9 kB / 481.1 MB, free: 18.83 MB / 366.1 MB
Notification: Performance of preOpt clockPartitioning (simulation): time 0.007564/0.3412, allocations: 8.296 MB / 489.4 MB, free: 10.85 MB / 366.1 MB
Notification: Performance of preOpt findStateOrder (simulation): time 4.675e-05/0.3412, allocations: 4.188 kB / 489.4 MB, free: 10.85 MB / 366.1 MB
Notification: Performance of preOpt replaceEdgeChange (simulation): time 0.0001761/0.3414, allocations: 95.92 kB / 489.5 MB, free: 10.76 MB / 366.1 MB
Notification: Performance of preOpt inlineArrayEqn (simulation): time 0.0002449/0.3416, allocations: 311.9 kB / 489.8 MB, free: 10.45 MB / 366.1 MB
Notification: Performance of preOpt removeEqualRHS (simulation): time 0.01327/0.3549, allocations: 14.21 MB / 0.4922 GB, free: 12.23 MB / 382.1 MB
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.03405/0.3889, allocations: 16.27 MB / 0.5081 GB, free: 11.88 MB / 398.1 MB
Notification: Performance of preOpt comSubExp (simulation): time 0.005374/0.3943, allocations: 2.77 MB / 0.5108 GB, free: 9.113 MB / 398.1 MB
Notification: Performance of preOpt resolveLoops (simulation): time 0.004249/0.3986, allocations: 2.433 MB / 0.5132 GB, free: 6.68 MB / 398.1 MB
Notification: Performance of preOpt evalFunc (simulation): time 0.02604/0.4246, allocations: 12.51 MB / 0.5254 GB, free: 10.13 MB / 414.1 MB
Notification: Performance of preOpt encapsulateWhenConditions (simulation): time 5.85e-05/0.4247, allocations: 47.55 kB / 0.5254 GB, free: 10.07 MB / 414.1 MB
Notification: Performance of pre-optimization done (n=160): time 4.038e-06/0.4247, allocations: 0 / 0.5254 GB, free: 10.07 MB / 414.1 MB
Notification: Performance of matching and sorting (n=230): time 0.06303/0.4877, allocations: 22.58 MB / 0.5475 GB, free: 3.422 MB / 430.1 MB
Notification: Performance of inlineWhenForInitialization (initialization): time 8.011e-05/0.4878, allocations: 64.72 kB / 0.5475 GB, free: 3.348 MB / 430.1 MB
[/home/hudson/saved_omc/libraries/.openmodelica/libraries/Chemical master/Interfaces.mo:1348:3-1348:137:writable] Warning: Parameter reaction.nextProducts[1].data.VmExcess has no value, and is fixed during initialization (fixed=true), using available start value (start=0.0) as default value.
[/home/hudson/saved_omc/libraries/.openmodelica/libraries/Chemical master/Interfaces.mo:1347:3-1347:140:writable] Warning: Parameter reaction.nextProducts[1].data.VmBase has no value, and is fixed during initialization (fixed=true), using available start value (start=0.0) as default value.
[/home/hudson/saved_omc/libraries/.openmodelica/libraries/Chemical master/Interfaces.mo:1344:3-1344:89:writable] Warning: Parameter reaction.nextProducts[1].data.phase has no value, and is fixed during initialization (fixed=true), using available start value (start=Chemical.Interfaces.Phase.Gas) as default value.
[/home/hudson/saved_omc/libraries/.openmodelica/libraries/Chemical master/Interfaces.mo:1341:3-1342:83:writable] Warning: Parameter reaction.nextProducts[1].data.z has no value, and is fixed during initialization (fixed=true), using available start value (start=0.0) as default value.
[/home/hudson/saved_omc/libraries/.openmodelica/libraries/Chemical master/Interfaces.mo:1339:3-1339:81:writable] Warning: Parameter reaction.nextProducts[1].data.bhigh[3] has no value, and is fixed during initialization (fixed=true), using available start value (start=0.0) as default value.
[/home/hudson/saved_omc/libraries/.openmodelica/libraries/Chemical master/Interfaces.mo:1339:3-1339:81:writable] Warning: Parameter reaction.nextProducts[1].data.bhigh[2] has no value, and is fixed during initialization (fixed=true), using available start value (start=0.0) as default value.
[/home/hudson/saved_omc/libraries/.openmodelica/libraries/Chemical master/Interfaces.mo:1339:3-1339:81:writable] Warning: Parameter reaction.nextProducts[1].data.bhigh[1] has no value, and is fixed during initialization (fixed=true), using available start value (start=0.0) as default value.
[/home/hudson/saved_omc/libraries/.openmodelica/libraries/Chemical master/Interfaces.mo:1338:3-1338:84:writable] Warning: Parameter reaction.nextProducts[1].data.ahigh[7] has no value, and is fixed during initialization (fixed=true), using available start value (start=0.0) as default value.
[/home/hudson/saved_omc/libraries/.openmodelica/libraries/Chemical master/Interfaces.mo:1338:3-1338:84:writable] Warning: Parameter reaction.nextProducts[1].data.ahigh[6] has no value, and is fixed during initialization (fixed=true), using available start value (start=0.0) as default value.
[/home/hudson/saved_omc/libraries/.openmodelica/libraries/Chemical master/Interfaces.mo:1338:3-1338:84:writable] Warning: Parameter reaction.nextProducts[1].data.ahigh[5] has no value, and is fixed during initialization (fixed=true), using available start value (start=0.0) as default value.
[/home/hudson/saved_omc/libraries/.openmodelica/libraries/Chemical master/Interfaces.mo:1338:3-1338:84:writable] Warning: Parameter reaction.nextProducts[1].data.ahigh[4] has no value, and is fixed during initialization (fixed=true), using available start value (start=0.0) as default value.
[/home/hudson/saved_omc/libraries/.openmodelica/libraries/Chemical master/Interfaces.mo:1338:3-1338:84:writable] Warning: Parameter reaction.nextProducts[1].data.ahigh[3] has no value, and is fixed during initialization (fixed=true), using available start value (start=0.0) as default value.
[/home/hudson/saved_omc/libraries/.openmodelica/libraries/Chemical master/Interfaces.mo:1338:3-1338:84:writable] Warning: Parameter reaction.nextProducts[1].data.ahigh[2] has no value, and is fixed during initialization (fixed=true), using available start value (start=0.0) as default value.
[/home/hudson/saved_omc/libraries/.openmodelica/libraries/Chemical master/Interfaces.mo:1338:3-1338:84:writable] Warning: Parameter reaction.nextProducts[1].data.ahigh[1] has no value, and is fixed during initialization (fixed=true), using available start value (start=0.0) as default value.
[/home/hudson/saved_omc/libraries/.openmodelica/libraries/Chemical master/Interfaces.mo:1337:3-1337:79:writable] Warning: Parameter reaction.nextProducts[1].data.blow[3] has no value, and is fixed during initialization (fixed=true), using available start value (start=0.0) as default value.
[/home/hudson/saved_omc/libraries/.openmodelica/libraries/Chemical master/Interfaces.mo:1337:3-1337:79:writable] Warning: Parameter reaction.nextProducts[1].data.blow[2] has no value, and is fixed during initialization (fixed=true), using available start value (start=0.0) as default value.
[/home/hudson/saved_omc/libraries/.openmodelica/libraries/Chemical master/Interfaces.mo:1337:3-1337:79:writable] Warning: Parameter reaction.nextProducts[1].data.blow[1] has no value, and is fixed during initialization (fixed=true), using available start value (start=0.0) as default value.
[/home/hudson/saved_omc/libraries/.openmodelica/libraries/Chemical master/Interfaces.mo:1336:3-1336:82:writable] Warning: Parameter reaction.nextProducts[1].data.alow[7] has no value, and is fixed during initialization (fixed=true), using available start value (start=0.0) as default value.
[/home/hudson/saved_omc/libraries/.openmodelica/libraries/Chemical master/Interfaces.mo:1336:3-1336:82:writable] Warning: Parameter reaction.nextProducts[1].data.alow[6] has no value, and is fixed during initialization (fixed=true), using available start value (start=0.0) as default value.
[/home/hudson/saved_omc/libraries/.openmodelica/libraries/Chemical master/Interfaces.mo:1336:3-1336:82:writable] Warning: Parameter reaction.nextProducts[1].data.alow[5] has no value, and is fixed during initialization (fixed=true), using available start value (start=0.0) as default value.
[/home/hudson/saved_omc/libraries/.openmodelica/libraries/Chemical master/Interfaces.mo:1336:3-1336:82:writable] Warning: Parameter reaction.nextProducts[1].data.alow[4] has no value, and is fixed during initialization (fixed=true), using available start value (start=0.0) as default value.
[/home/hudson/saved_omc/libraries/.openmodelica/libraries/Chemical master/Interfaces.mo:1336:3-1336:82:writable] Warning: Parameter reaction.nextProducts[1].data.alow[3] has no value, and is fixed during initialization (fixed=true), using available start value (start=0.0) as default value.
[/home/hudson/saved_omc/libraries/.openmodelica/libraries/Chemical master/Interfaces.mo:1336:3-1336:82:writable] Warning: Parameter reaction.nextProducts[1].data.alow[2] has no value, and is fixed during initialization (fixed=true), using available start value (start=0.0) as default value.
[/home/hudson/saved_omc/libraries/.openmodelica/libraries/Chemical master/Interfaces.mo:1336:3-1336:82:writable] Warning: Parameter reaction.nextProducts[1].data.alow[1] has no value, and is fixed during initialization (fixed=true), using available start value (start=0.0) as default value.
[/home/hudson/saved_omc/libraries/.openmodelica/libraries/Chemical master/Interfaces.mo:1334:3-1334:81:writable] Warning: Parameter reaction.nextProducts[1].data.H0 has no value, and is fixed during initialization (fixed=true), using available start value (start=0.0) as default value.
[/home/hudson/saved_omc/libraries/.openmodelica/libraries/Chemical master/Interfaces.mo:1333:3-1333:87:writable] Warning: Parameter reaction.nextProducts[1].data.Hf has no value, and is fixed during initialization (fixed=true), using available start value (start=0.0) as default value.
[/home/hudson/saved_omc/libraries/.openmodelica/libraries/Chemical master/Interfaces.mo:1332:3-1332:55:writable] Warning: Parameter reaction.nextProducts[1].data.MM has no value, and is fixed during initialization (fixed=true), using available start value (start=0.0) as default value.
Notification: Performance of selectInitializationVariablesDAE (initialization): time 0.002918/0.4907, allocations: 1.453 MB / 0.5489 GB, free: 1.891 MB / 430.1 MB
Notification: Performance of collectPreVariables (initialization): time 0.0008536/0.4916, allocations: 49.7 kB / 0.549 GB, free: 1.836 MB / 430.1 MB
Notification: Performance of collectInitialEqns (initialization): time 0.001281/0.4928, allocations: 1.314 MB / 0.5503 GB, free: 0.5117 MB / 430.1 MB
Notification: Performance of collectInitialBindings (initialization): time 0.001566/0.4944, allocations: 0.7783 MB / 0.551 GB, free: 15.72 MB / 446.1 MB
Notification: Performance of simplifyInitialFunctions (initialization): time 0.002206/0.4966, allocations: 0.5663 MB / 0.5516 GB, free: 15.15 MB / 446.1 MB
Notification: Performance of setup shared object (initialization): time 0.0001445/0.4968, allocations: 301.1 kB / 0.5519 GB, free: 14.85 MB / 446.1 MB
Notification: Performance of preBalanceInitialSystem (initialization): time 0.006321/0.5031, allocations: 3.373 MB / 0.5552 GB, free: 11.48 MB / 446.1 MB
Notification: Performance of partitionIndependentBlocks (initialization): time 0.006354/0.5094, allocations: 3.899 MB / 0.559 GB, free: 7.355 MB / 446.1 MB
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.
Notification: Performance of analyzeInitialSystem (initialization): time 0.3668/0.8763, allocations: 57.72 MB / 0.6153 GB, free: 14.04 MB / 0.4981 GB
Warning: It was not possible to solve the under-determined initial system (205 equations and 233 variables)
Error: No system for the symbolic initialization was generated
"
[Timeout remaining time 659]
[Calling sys.exit(0), Time elapsed: 3.612835556268692]
Failed to read output from testmodel.py, exit status != 0:
0.8995036482810974 1.145499668 0.820397422
Calling exit ...
<OMPython.OMCSessionZMQ object at 0x7f94459b91e0>