Running: ./testmodel.py --libraries=/home/hudson/saved_omc/libraries/.openmodelica/libraries/ --ompython_omhome=/usr Chemical_Chemical.Examples.CheckSubstancesData.SimpleReaction2.conf.json
loadFile("/home/hudson/saved_omc/libraries/.openmodelica/libraries/Chemical 1.4.0-master/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/ModelicaServices 4.0.0+maint.om/package.mo", uses=false)
Using package ModelicaServices with version 4.0.0 (/home/hudson/saved_omc/libraries/.openmodelica/libraries/ModelicaServices 4.0.0+maint.om/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 Chemical with version 1.4.0 (/home/hudson/saved_omc/libraries/.openmodelica/libraries/Chemical 1.4.0-master/package.mo)
Running command: translateModel(Chemical.Examples.CheckSubstancesData.SimpleReaction2,tolerance=1e-06,outputFormat="empty",numberOfIntervals=5000,variableFilter="",fileNamePrefix="Chemical_Chemical.Examples.CheckSubstancesData.SimpleReaction2")
translateModel(Chemical.Examples.CheckSubstancesData.SimpleReaction2,tolerance=1e-06,outputFormat="empty",numberOfIntervals=5000,variableFilter="",fileNamePrefix="Chemical_Chemical.Examples.CheckSubstancesData.SimpleReaction2")
Notification: Performance of loadFile(/home/hudson/saved_omc/libraries/.openmodelica/libraries/Chemical 1.4.0-master/package.mo): time 0.09884/0.09884, allocations: 15.25 MB / 27.81 MB, free: 5.395 MB / 24.77 MB
Notification: Performance of loadFile(/home/hudson/saved_omc/libraries/.openmodelica/libraries/Complex 4.0.0+maint.om/package.mo): time 0.001348/0.001348, allocations: 188.4 kB / 32.7 MB, free: 0.5117 MB / 24.77 MB
Notification: Performance of loadFile(/home/hudson/saved_omc/libraries/.openmodelica/libraries/Modelica 4.0.0+maint.om/package.mo): time 1.375/1.375, allocations: 221.4 MB / 258.8 MB, free: 4 kB / 202.7 MB
Notification: Performance of loadFile(/home/hudson/saved_omc/libraries/.openmodelica/libraries/ModelicaServices 4.0.0+maint.om/package.mo): time 0.0009496/0.0009498, allocations: 102.1 kB / 314 MB, free: 15.77 MB / 250.7 MB
Notification: Performance of FrontEnd - loaded program: time 3.204e-05/3.208e-05, allocations: 4 kB / 376.5 MB, free: 1.441 MB / 298.7 MB
Notification: Performance of FrontEnd - Absyn->SCode: time 0.3383/0.3383, allocations: 54.6 MB / 431.1 MB, free: 50.01 MB / 346.7 MB
Notification: Performance of FrontEnd - scodeFlatten: time 0.1186/0.457, allocations: 94.88 MB / 0.5136 GB, free: 4.426 MB / 378.7 MB
Notification: Performance of FrontEnd - mkProgramGraph: time 0.0002489/0.4573, allocations: 75.95 kB / 0.5137 GB, free: 4.352 MB / 378.7 MB
[/home/hudson/saved_omc/libraries/.openmodelica/libraries/Chemical 1.4.0-master/package.mo:3011:6-3011:65:writable] Warning: No corresponding 'inner' declaration found for component .Modelica.Fluid.System A.system declared as 'outer '.
  The existing 'inner' components are:
    There are no 'inner' components defined in the model in any of the parent scopes of 'outer' component's scope: Chemical.Sources.PureSubstance.
  Check if you have not misspelled the 'outer' component name.
  Please declare an 'inner' component with the same name in the top scope.
  Continuing flattening by only considering the 'outer' component declaration.
[/home/hudson/saved_omc/libraries/.openmodelica/libraries/Chemical 1.4.0-master/package.mo:1535:7-1535:66:writable] Warning: No corresponding 'inner' declaration found for component .Modelica.Fluid.System reaction.system declared as 'outer '.
  The existing 'inner' components are:
    There are no 'inner' components defined in the model in any of the parent scopes of 'outer' component's scope: Chemical.Sensors.DissociationCoefficient$reaction.
  Check if you have not misspelled the 'outer' component name.
  Please declare an 'inner' component with the same name in the top scope.
  Continuing flattening by only considering the 'outer' component declaration.
[/home/hudson/saved_omc/libraries/.openmodelica/libraries/Chemical 1.4.0-master/package.mo:3011:6-3011:65:writable] Warning: No corresponding 'inner' declaration found for component .Modelica.Fluid.System B.system declared as 'outer '.
  The existing 'inner' components are:
    There are no 'inner' components defined in the model in any of the parent scopes of 'outer' component's scope: Chemical.Sources.PureSubstance.
  Check if you have not misspelled the 'outer' component name.
  Please declare an 'inner' component with the same name in the top scope.
  Continuing flattening by only considering the 'outer' component declaration.
[/home/hudson/saved_omc/libraries/.openmodelica/libraries/Chemical 1.4.0-master/package.mo:3011:6-3011:65:writable] Warning: No corresponding 'inner' declaration found for component .Modelica.Fluid.System C.system declared as 'outer '.
  The existing 'inner' components are:
    There are no 'inner' components defined in the model in any of the parent scopes of 'outer' component's scope: Chemical.Sources.PureSubstance$C.
  Check if you have not misspelled the 'outer' component name.
  Please declare an 'inner' component with the same name in the top scope.
  Continuing flattening by only considering the 'outer' component declaration.
Notification: Performance of FrontEnd - DAE generated: time 0.04786/0.5052, allocations: 19.35 MB / 0.5326 GB, free: 1.188 MB / 394.7 MB
Notification: Performance of FrontEnd: time 2.224e-06/0.5052, allocations: 0 / 0.5326 GB, free: 1.188 MB / 394.7 MB
Notification: Performance of Transformations before backend: time 4.566e-05/0.5053, allocations: 19.92 kB / 0.5326 GB, free: 1.168 MB / 394.7 MB
Notification: Model statistics after passing the front-end and creating the data structures used by the back-end:
 * Number of equations: 76
 * Number of variables: 76
Notification: Performance of Generate backend data structure: time 0.001304/0.5066, allocations: 0.7979 MB / 0.5334 GB, free: 332 kB / 394.7 MB
Notification: Performance of prepare preOptimizeDAE: time 5.097e-05/0.5066, allocations: 12.03 kB / 0.5334 GB, free: 320 kB / 394.7 MB
Notification: Performance of preOpt normalInlineFunction (simulation): time 0.0007534/0.5074, allocations: 211.4 kB / 0.5336 GB, free: 108 kB / 394.7 MB
Notification: Performance of preOpt evaluateParameters (simulation): time 0.0008099/0.5082, allocations: 0.4916 MB / 0.5341 GB, free: 15.57 MB / 410.7 MB
Notification: Performance of preOpt simplifyIfEquations (simulation): time 3.356e-05/0.5083, allocations: 24.78 kB / 0.5341 GB, free: 15.54 MB / 410.7 MB
Notification: Performance of preOpt expandDerOperator (simulation): time 6.065e-05/0.5083, allocations: 31.95 kB / 0.5341 GB, free: 15.51 MB / 410.7 MB
Notification: Performance of preOpt clockPartitioning (simulation): time 0.001321/0.5097, allocations: 0.9651 MB / 0.5351 GB, free: 14.52 MB / 410.7 MB
Notification: Performance of preOpt findStateOrder (simulation): time 1.726e-05/0.5097, allocations: 3.938 kB / 0.5351 GB, free: 14.51 MB / 410.7 MB
Notification: Performance of preOpt replaceEdgeChange (simulation): time 4.805e-05/0.5098, allocations: 16 kB / 0.5351 GB, free: 14.5 MB / 410.7 MB
Notification: Performance of preOpt inlineArrayEqn (simulation): time 1.226e-05/0.5098, allocations: 8 kB / 0.5351 GB, free: 14.49 MB / 410.7 MB
Notification: Performance of preOpt removeEqualRHS (simulation): time 0.001903/0.5117, allocations: 1.654 MB / 0.5367 GB, free: 12.84 MB / 410.7 MB
Notification: Performance of preOpt removeSimpleEquations (simulation): time 0.003683/0.5154, allocations: 2.998 MB / 0.5397 GB, free: 9.75 MB / 410.7 MB
Notification: Performance of preOpt comSubExp (simulation): time 0.0001123/0.5155, allocations: 58.5 kB / 0.5397 GB, free: 9.684 MB / 410.7 MB
Notification: Performance of preOpt resolveLoops (simulation): time 5.426e-05/0.5156, allocations: 32.06 kB / 0.5397 GB, free: 9.652 MB / 410.7 MB
Notification: Performance of preOpt evalFunc (simulation): time 2.271e-05/0.5156, allocations: 7.984 kB / 0.5398 GB, free: 9.645 MB / 410.7 MB
Notification: Performance of preOpt encapsulateWhenConditions (simulation): time 2.407e-05/0.5156, allocations: 30.56 kB / 0.5398 GB, free: 9.605 MB / 410.7 MB
Notification: Performance of pre-optimization done (n=5): time 3.026e-06/0.5156, allocations: 4 kB / 0.5398 GB, free: 9.602 MB / 410.7 MB
Notification: Performance of matching and sorting (n=5): time 0.0002924/0.5159, allocations: 142.3 kB / 0.5399 GB, free: 9.457 MB / 410.7 MB
Notification: Performance of inlineWhenForInitialization (initialization): time 4.698e-05/0.516, allocations: 51.41 kB / 0.54 GB, free: 9.395 MB / 410.7 MB
Notification: Performance of selectInitializationVariablesDAE (initialization): time 0.001794/0.5178, allocations: 1.722 MB / 0.5417 GB, free: 7.664 MB / 410.7 MB
Notification: Performance of collectPreVariables (initialization): time 1.633e-05/0.5178, allocations: 25.7 kB / 0.5417 GB, free: 7.633 MB / 410.7 MB
Notification: Performance of collectInitialEqns (initialization): time 0.0002611/0.5181, allocations: 386.3 kB / 0.542 GB, free: 7.25 MB / 410.7 MB
Notification: Performance of collectInitialBindings (initialization): time 2.249e-05/0.5181, allocations: 27.73 kB / 0.5421 GB, free: 7.223 MB / 410.7 MB
Notification: Performance of simplifyInitialFunctions (initialization): time 2.503e-05/0.5182, allocations: 8 kB / 0.5421 GB, free: 7.215 MB / 410.7 MB
Notification: Performance of setup shared object (initialization): time 0.0001583/0.5183, allocations: 378.7 kB / 0.5424 GB, free: 6.836 MB / 410.7 MB
Notification: Performance of preBalanceInitialSystem (initialization): time 0.0005023/0.5188, allocations: 492.7 kB / 0.5429 GB, free: 6.355 MB / 410.7 MB
Notification: Performance of partitionIndependentBlocks (initialization): time 0.0005833/0.5194, allocations: 0.6469 MB / 0.5435 GB, free: 5.629 MB / 410.7 MB
Notification: Performance of analyzeInitialSystem (initialization): time 0.0005858/0.52, allocations: 0.5245 MB / 0.5441 GB, free: 5.105 MB / 410.7 MB
Notification: Performance of solveInitialSystemEqSystem (initialization): time 4.388e-06/0.52, allocations: 0 / 0.5441 GB, free: 5.105 MB / 410.7 MB
Notification: Performance of matching and sorting (n=53) (initialization): time 0.001436/0.5215, allocations: 1.227 MB / 0.5453 GB, free: 3.871 MB / 410.7 MB
Notification: Performance of prepare postOptimizeDAE: time 2.271e-05/0.5215, allocations: 8 kB / 0.5453 GB, free: 3.863 MB / 410.7 MB
Notification: Performance of postOpt simplifyComplexFunction (initialization): time 1.19e-05/0.5215, allocations: 8.031 kB / 0.5453 GB, free: 3.855 MB / 410.7 MB
Notification: Performance of postOpt tearingSystem (initialization): time 2.001e-05/0.5215, allocations: 8 kB / 0.5453 GB, free: 3.848 MB / 410.7 MB
Notification: Performance of postOpt solveSimpleEquations (initialization): time 0.0004198/0.522, allocations: 111.8 kB / 0.5454 GB, free: 3.738 MB / 410.7 MB
Notification: Performance of postOpt calculateStrongComponentJacobians (initialization): time 1.694e-05/0.522, allocations: 11.94 kB / 0.5454 GB, free: 3.727 MB / 410.7 MB
Notification: Performance of postOpt simplifyAllExpressions (initialization): time 0.0005474/0.5226, allocations: 75.2 kB / 0.5455 GB, free: 3.652 MB / 410.7 MB
Notification: Performance of postOpt collapseArrayExpressions (initialization): time 4.722e-05/0.5226, allocations: 27.98 kB / 0.5455 GB, free: 3.625 MB / 410.7 MB
Notification: Model statistics after passing the back-end for initialization:
 * Number of independent subsystems: 26
 * Number of states: 0 ()
 * Number of discrete variables: 0 ()
 * Number of discrete states: 0 ()
 * Top-level inputs: 0
Notification: Strong component statistics for initialization (53):
 * Single equations (assignments): 53
 * Array equations: 0
 * Algorithm blocks: 0
 * Record equations: 0
 * When equations: 0
 * If-equations: 0
 * Equation systems (linear and non-linear blocks): 0
 * Torn equation systems: 0
 * Mixed (continuous/discrete) equation systems: 0
Notification: Performance of prepare postOptimizeDAE: time 0.0001004/0.5227, allocations: 128.8 kB / 0.5456 GB, free: 3.492 MB / 410.7 MB
Notification: Performance of postOpt lateInlineFunction (simulation): time 8.199e-05/0.5228, allocations: 59.25 kB / 0.5457 GB, free: 3.434 MB / 410.7 MB
Notification: Performance of postOpt wrapFunctionCalls (simulation): time 0.0002886/0.5231, allocations: 165 kB / 0.5458 GB, free: 3.266 MB / 410.7 MB
Notification: Performance of postOpt inlineArrayEqn (simulation): time 3.998e-06/0.5231, allocations: 0 / 0.5458 GB, free: 3.266 MB / 410.7 MB
Notification: Performance of postOpt constantLinearSystem (simulation): time 5.34e-06/0.5231, allocations: 0 / 0.5458 GB, free: 3.266 MB / 410.7 MB
Notification: Performance of postOpt simplifysemiLinear (simulation): time 3.176e-06/0.5231, allocations: 0 / 0.5458 GB, free: 3.266 MB / 410.7 MB
Notification: Performance of postOpt removeSimpleEquations (simulation): time 0.0009751/0.5241, allocations: 0.8069 MB / 0.5466 GB, free: 2.383 MB / 410.7 MB
Notification: Performance of postOpt simplifyComplexFunction (simulation): time 3.557e-06/0.5241, allocations: 4 kB / 0.5466 GB, free: 2.379 MB / 410.7 MB
Notification: Performance of postOpt solveSimpleEquations (simulation): time 7.181e-05/0.5242, allocations: 15.98 kB / 0.5466 GB, free: 2.363 MB / 410.7 MB
Notification: Performance of postOpt tearingSystem (simulation): time 6.152e-06/0.5242, allocations: 5.125 kB / 0.5466 GB, free: 2.359 MB / 410.7 MB
Notification: Performance of postOpt inputDerivativesUsed (simulation): time 1.034e-05/0.5243, allocations: 0 / 0.5466 GB, free: 2.359 MB / 410.7 MB
Notification: Performance of postOpt calculateStrongComponentJacobians (simulation): time 3.627e-06/0.5243, allocations: 4 kB / 0.5466 GB, free: 2.355 MB / 410.7 MB
Notification: Performance of postOpt calculateStateSetsJacobians (simulation): time 4.398e-06/0.5243, allocations: 7.891 kB / 0.5467 GB, free: 2.348 MB / 410.7 MB
Notification: Performance of postOpt symbolicJacobian (simulation): time 0.0002881/0.5246, allocations: 264.5 kB / 0.5469 GB, free: 2.027 MB / 410.7 MB
Notification: Performance of postOpt removeConstants (simulation): time 0.0002815/0.5249, allocations: 188.2 kB / 0.5471 GB, free: 1.824 MB / 410.7 MB
Notification: Performance of postOpt simplifyTimeIndepFuncCalls (simulation): time 7.545e-05/0.5249, allocations: 4 kB / 0.5471 GB, free: 1.82 MB / 410.7 MB
Notification: Performance of postOpt simplifyAllExpressions (simulation): time 0.0002119/0.5252, allocations: 4 kB / 0.5471 GB, free: 1.816 MB / 410.7 MB
Notification: Performance of postOpt findZeroCrossings (simulation): time 2.577e-05/0.5252, allocations: 15.88 kB / 0.5471 GB, free: 1.801 MB / 410.7 MB
Notification: Performance of postOpt collapseArrayExpressions (simulation): time 7.985e-06/0.5252, allocations: 8 kB / 0.5471 GB, free: 1.793 MB / 410.7 MB
Notification: Performance of sorting global known variables: time 0.001453/0.5267, allocations: 1.362 MB / 0.5484 GB, free: 444 kB / 410.7 MB
Notification: Performance of sort global known variables: time 1.7e-07/0.5267, allocations: 0 / 0.5484 GB, free: 444 kB / 410.7 MB
Notification: Performance of remove unused functions: time 0.0008915/0.5276, allocations: 280.3 kB / 0.5487 GB, free: 164 kB / 410.7 MB
Notification: Model statistics after passing the back-end for simulation:
 * Number of independent subsystems: 6
 * Number of states: 0 ()
 * Number of discrete variables: 0 ()
 * Number of discrete states: 0 ()
 * Top-level inputs: 0
Notification: Strong component statistics for simulation (6):
 * Single equations (assignments): 6
 * Array equations: 0
 * Algorithm blocks: 0
 * Record equations: 0
 * When equations: 0
 * If-equations: 0
 * Equation systems (linear and non-linear blocks): 0
 * Torn equation systems: 0
 * Mixed (continuous/discrete) equation systems: 0
Notification: Performance of Backend phase and start with SimCode phase: time 0.0007113/0.5283, allocations: 369.3 kB / 0.5491 GB, free: 15.79 MB / 426.7 MB
Notification: Performance of simCode: created initialization part: time 0.0009015/0.5292, allocations: 0.5972 MB / 0.5496 GB, free: 15.2 MB / 426.7 MB
Notification: Performance of simCode: created event and clocks part: time 4.147e-06/0.5292, allocations: 0 / 0.5496 GB, free: 15.2 MB / 426.7 MB
Notification: Performance of simCode: created simulation system equations: time 5.935e-05/0.5293, allocations: 41.47 kB / 0.5497 GB, free: 15.16 MB / 426.7 MB
Notification: Performance of simCode: created of all other equations (e.g. parameter, nominal, assert, etc): time 0.0009425/0.5302, allocations: 214.4 kB / 0.5499 GB, free: 14.96 MB / 426.7 MB
Notification: Performance of simCode: created linear, non-linear and system jacobian parts: time 0.0009157/0.5312, allocations: 0.5392 MB / 0.5504 GB, free: 14.39 MB / 426.7 MB
Notification: Performance of simCode: some other stuff during SimCode phase: time 0.0004045/0.5316, allocations: 0.8622 MB / 0.5513 GB, free: 13.5 MB / 426.7 MB
Notification: Performance of simCode: alias equations: time 0.0003772/0.532, allocations: 122.1 kB / 0.5514 GB, free: 13.4 MB / 426.7 MB
Notification: Performance of simCode: all other stuff during SimCode phase: time 0.0001021/0.5321, allocations: 47.42 kB / 0.5514 GB, free: 13.35 MB / 426.7 MB
Notification: Performance of SimCode: time 4e-07/0.5321, allocations: 0 / 0.5514 GB, free: 13.35 MB / 426.7 MB
Notification: Performance of Templates: time 0.02171/0.5538, allocations: 11.71 MB / 0.5629 GB, free: 1.832 MB / 426.7 MB
make -j1 -f Chemical_Chemical.Examples.CheckSubstancesData.SimpleReaction2.makefile
(rm -f Chemical_Chemical.Examples.CheckSubstancesData.SimpleReaction2.pipe ; mkfifo Chemical_Chemical.Examples.CheckSubstancesData.SimpleReaction2.pipe ; head -c 1048576 < Chemical_Chemical.Examples.CheckSubstancesData.SimpleReaction2.pipe >> ../files/Chemical_Chemical.Examples.CheckSubstancesData.SimpleReaction2.sim & ./Chemical_Chemical.Examples.CheckSubstancesData.SimpleReaction2  -abortSlowSimulation -alarm=480 -lv LOG_STATS > Chemical_Chemical.Examples.CheckSubstancesData.SimpleReaction2.pipe 2>&1)