Running: ./testmodel.py --libraries=/home/hudson/saved_omc/libraries/.openmodelica/libraries --ompython_omhome=/usr Modelica_trunk_Modelica.Fluid.Examples.ControlledTankSystem.ControlledTanks.conf.json
loadFile("/home/hudson/saved_omc/libraries/.openmodelica/libraries/ModelicaServices trunk/package.mo", uses=false) [Timeout 180]
"Notification: Performance of loadFile(/home/hudson/saved_omc/libraries/.openmodelica/libraries/ModelicaServices trunk/package.mo): time 0.00182/0.00182, allocations: 116.8 kB / 19.17 MB, free: 3.895 MB / 14.72 MB
"
[Timeout remaining time 180]
loadFile("/home/hudson/saved_omc/libraries/.openmodelica/libraries/Complex trunk/package.mo", uses=false) [Timeout 180]
"Notification: Performance of loadFile(/home/hudson/saved_omc/libraries/.openmodelica/libraries/Complex trunk/package.mo): time 0.002235/0.002235, allocations: 214.6 kB / 22.13 MB, free: 0.9375 MB / 14.72 MB
"
[Timeout remaining time 180]
loadFile("/home/hudson/saved_omc/libraries/.openmodelica/libraries/Modelica trunk/package.mo", uses=false) [Timeout 180]
"Notification: Performance of loadFile(/home/hudson/saved_omc/libraries/.openmodelica/libraries/Modelica trunk/package.mo): time 1.509/1.509, allocations: 230.2 MB / 255.2 MB, free: 15.4 MB / 206.1 MB
"
[Timeout remaining time 178]
Using package Modelica with version trunk (/home/hudson/saved_omc/libraries/.openmodelica/libraries/Modelica trunk/package.mo)
Using package Complex with version trunk (/home/hudson/saved_omc/libraries/.openmodelica/libraries/Complex trunk/package.mo)
Using package ModelicaServices with version trunk (/home/hudson/saved_omc/libraries/.openmodelica/libraries/ModelicaServices trunk/package.mo)
Running command: translateModel(Modelica.Fluid.Examples.ControlledTankSystem.ControlledTanks,tolerance=1e-06,outputFormat="mat",numberOfIntervals=5036,variableFilter="time|tank1.level|tank1.medium.T|tank2.level|tank2.medium.T|shut.on|shut.reset.1.|shut.reset.2.|start.on|start.reset.1.|start.reset.2.|stop.on|stop.reset.1.|stop.reset.2.|tankController.T1.enableFire|tankController.T2.enableFire|tankController.T3.enableFire|tankController.T4.enableFire|tankController.T5.enableFire|tankController.T6.enableFire|tankController.normal.T1.enableFire|tankController.normal.T2.enableFire|tankController.normal.T3.enableFire|tankController.normal.T4.enableFire",fileNamePrefix="Modelica_trunk_Modelica.Fluid.Examples.ControlledTankSystem.ControlledTanks")
translateModel(Modelica.Fluid.Examples.ControlledTankSystem.ControlledTanks,tolerance=1e-06,outputFormat="mat",numberOfIntervals=5036,variableFilter="time|tank1.level|tank1.medium.T|tank2.level|tank2.medium.T|shut.on|shut.reset.1.|shut.reset.2.|start.on|start.reset.1.|start.reset.2.|stop.on|stop.reset.1.|stop.reset.2.|tankController.T1.enableFire|tankController.T2.enableFire|tankController.T3.enableFire|tankController.T4.enableFire|tankController.T5.enableFire|tankController.T6.enableFire|tankController.normal.T1.enableFire|tankController.normal.T2.enableFire|tankController.normal.T3.enableFire|tankController.normal.T4.enableFire",fileNamePrefix="Modelica_trunk_Modelica.Fluid.Examples.ControlledTankSystem.ControlledTanks") [Timeout 660]
"Notification: Performance of FrontEnd - loaded program: time 0.001898/0.001898, allocations: 71.88 kB / 374.5 MB, free: 9.938 MB / 302.1 MB
Notification: Performance of FrontEnd - Absyn->SCode: time 0.1124/0.1143, allocations: 53.32 MB / 427.8 MB, free: 4.52 MB / 350.1 MB
Notification: Performance of NFInst.instantiate(Modelica.Fluid.Examples.ControlledTankSystem.ControlledTanks): time 0.2642/0.3786, allocations: 28.14 MB / 456 MB, free: 8.168 MB / 366.1 MB
Notification: Performance of NFInst.instExpressions: time 0.01157/0.3902, allocations: 7.601 MB / 463.6 MB, free: 7.699 MB / 366.1 MB
Notification: Performance of NFInst.updateImplicitVariability: time 0.002202/0.3924, allocations: 49.28 kB / 463.6 MB, free: 7.684 MB / 366.1 MB
Notification: Performance of NFTyping.typeComponents: time 0.003015/0.3954, allocations: 1.02 MB / 464.6 MB, free: 7.18 MB / 366.1 MB
Notification: Performance of NFTyping.typeBindings: time 0.00457/0.3999, allocations: 1.644 MB / 466.3 MB, free: 6.219 MB / 366.1 MB
Notification: Performance of NFTyping.typeClassSections: time 0.005782/0.4057, allocations: 2.162 MB / 468.4 MB, free: 5.039 MB / 366.1 MB
Notification: Performance of NFFlatten.flatten: time 0.006923/0.4126, allocations: 5.04 MB / 473.5 MB, free: 2.691 MB / 366.1 MB
Notification: Performance of NFFlatten.resolveConnections: time 0.002728/0.4154, allocations: 1.798 MB / 475.3 MB, free: 1.883 MB / 366.1 MB
Notification: Performance of NFEvalConstants.evaluate: time 0.002743/0.4181, allocations: 1.783 MB / 477.1 MB, free: 1.062 MB / 366.1 MB
Notification: Performance of NFSimplifyModel.simplify: time 0.002182/0.4203, allocations: 1.739 MB / 478.8 MB, free: 264 kB / 366.1 MB
Notification: Performance of NFPackage.collectConstants: time 0.0005265/0.4208, allocations: 311.4 kB / 479.1 MB, free: 264 kB / 366.1 MB
Notification: Performance of NFFlatten.collectFunctions: time 0.002472/0.4233, allocations: 0.9755 MB / 480.1 MB, free: 15.9 MB / 382.1 MB
Notification: Performance of NFScalarize.scalarize: time 0.0009765/0.4243, allocations: 0.8746 MB / 481 MB, free: 15.23 MB / 382.1 MB
Notification: Performance of NFVerifyModel.verify: time 0.001795/0.4261, allocations: 1.392 MB / 482.3 MB, free: 14.21 MB / 382.1 MB
Notification: Performance of NFConvertDAE.convert: time 0.006385/0.4324, allocations: 4.278 MB / 486.6 MB, free: 11.13 MB / 382.1 MB
Notification: Performance of FrontEnd - DAE generated: time 4.889e-06/0.4325, allocations: 0 / 486.6 MB, free: 11.13 MB / 382.1 MB
Notification: Performance of FrontEnd: time 2.354e-06/0.4325, allocations: 0 / 486.6 MB, free: 11.13 MB / 382.1 MB
Notification: Performance of Transformations before backend: time 8.205e-05/0.4325, allocations: 4 kB / 486.6 MB, free: 11.12 MB / 382.1 MB
Notification: Model statistics after passing the front-end and creating the data structures used by the back-end:
 * Number of equations: 527
 * Number of variables: 527
Notification: Performance of Generate backend data structure: time 0.007335/0.4399, allocations: 3.193 MB / 489.8 MB, free: 8.648 MB / 382.1 MB
Notification: Performance of prepare preOptimizeDAE: time 3.857e-05/0.4399, allocations: 13.5 kB / 489.8 MB, free: 8.645 MB / 382.1 MB
Notification: Performance of preOpt normalInlineFunction (simulation): time 0.001631/0.4415, allocations: 342.7 kB / 490.2 MB, free: 8.48 MB / 382.1 MB
Notification: Performance of preOpt evaluateParameters (simulation): time 0.002732/0.4443, allocations: 1.49 MB / 491.7 MB, free: 7.336 MB / 382.1 MB
Notification: Performance of preOpt simplifyIfEquations (simulation): time 0.000301/0.4446, allocations: 304.9 kB / 492 MB, free: 7.121 MB / 382.1 MB
Notification: Performance of preOpt expandDerOperator (simulation): time 0.0003832/0.445, allocations: 221.9 kB / 492.2 MB, free: 7.051 MB / 382.1 MB
Notification: Performance of preOpt clockPartitioning (simulation): time 0.005501/0.4505, allocations: 2.758 MB / 494.9 MB, free: 5.238 MB / 382.1 MB
Notification: Performance of preOpt findStateOrder (simulation): time 5.185e-05/0.4505, allocations: 6.688 kB / 494.9 MB, free: 5.234 MB / 382.1 MB
Notification: Performance of preOpt replaceEdgeChange (simulation): time 0.0002455/0.4508, allocations: 84.75 kB / 495 MB, free: 5.176 MB / 382.1 MB
Notification: Performance of preOpt inlineArrayEqn (simulation): time 0.0001137/0.4509, allocations: 99.56 kB / 495.1 MB, free: 5.16 MB / 382.1 MB
Notification: Performance of preOpt removeEqualRHS (simulation): time 0.004211/0.4551, allocations: 2.196 MB / 497.3 MB, free: 4.059 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.01768/0.4728, allocations: 11.2 MB / 0.4966 GB, free: 9.59 MB / 398.1 MB
Notification: Performance of preOpt comSubExp (simulation): time 0.003351/0.4761, allocations: 1.892 MB / 0.4985 GB, free: 7.559 MB / 398.1 MB
Notification: Performance of preOpt resolveLoops (simulation): time 0.001834/0.4779, allocations: 0.9774 MB / 0.4994 GB, free: 6.559 MB / 398.1 MB
Notification: Performance of preOpt evalFunc (simulation): time 0.009287/0.4872, allocations: 5.33 MB / 0.5046 GB, free: 0.9023 MB / 398.1 MB
Notification: Performance of preOpt encapsulateWhenConditions (simulation): time 0.002627/0.4899, allocations: 1.522 MB / 0.5061 GB, free: 15.3 MB / 414.1 MB
Notification: Performance of pre-optimization done (n=205): time 4.299e-06/0.4899, allocations: 0 / 0.5061 GB, free: 15.3 MB / 414.1 MB
Notification: Performance of matching and sorting (n=215): time 0.01863/0.5085, allocations: 8.701 MB / 0.5146 GB, free: 6.426 MB / 414.1 MB
Notification: Performance of inlineWhenForInitialization (initialization): time 0.0005428/0.509, allocations: 0.7674 MB / 0.5153 GB, free: 5.488 MB / 414.1 MB
Notification: Performance of selectInitializationVariablesDAE (initialization): time 0.00261/0.5117, allocations: 1.679 MB / 0.517 GB, free: 3.797 MB / 414.1 MB
Notification: Performance of collectPreVariables (initialization): time 0.0005015/0.5122, allocations: 125.7 kB / 0.5171 GB, free: 3.668 MB / 414.1 MB
Notification: Performance of collectInitialEqns (initialization): time 0.0009154/0.5131, allocations: 0.9185 MB / 0.518 GB, free: 2.738 MB / 414.1 MB
Notification: Performance of collectInitialBindings (initialization): time 0.0008241/0.5139, allocations: 0.624 MB / 0.5186 GB, free: 2.109 MB / 414.1 MB
Notification: Performance of simplifyInitialFunctions (initialization): time 0.0009411/0.5148, allocations: 0.5641 MB / 0.5192 GB, free: 1.539 MB / 414.1 MB
Notification: Performance of setup shared object (initialization): time 0.0001322/0.515, allocations: 301.1 kB / 0.5194 GB, free: 1.242 MB / 414.1 MB
Notification: Performance of preBalanceInitialSystem (initialization): time 0.001944/0.5169, allocations: 0.9579 MB / 0.5204 GB, free: 288 kB / 414.1 MB
Notification: Performance of partitionIndependentBlocks (initialization): time 0.002632/0.5195, allocations: 1.67 MB / 0.522 GB, free: 14.31 MB / 430.1 MB
Notification: Performance of analyzeInitialSystem (initialization): time 0.004258/0.5238, allocations: 2.57 MB / 0.5245 GB, free: 11.45 MB / 430.1 MB
Notification: Performance of solveInitialSystemEqSystem (initialization): time 1.279e-05/0.5238, allocations: 4 kB / 0.5245 GB, free: 11.45 MB / 430.1 MB
Notification: Performance of matching and sorting (n=350) (initialization): time 0.006266/0.5301, allocations: 3.143 MB / 0.5276 GB, free: 8.273 MB / 430.1 MB
Notification: Performance of prepare postOptimizeDAE: time 0.000109/0.5302, allocations: 109.7 kB / 0.5277 GB, free: 8.148 MB / 430.1 MB
Notification: Performance of postOpt simplifyComplexFunction (initialization): time 3.221e-05/0.5302, allocations: 20 kB / 0.5277 GB, free: 8.129 MB / 430.1 MB
Notification: Performance of postOpt tearingSystem (initialization): time 0.001346/0.5316, allocations: 0.5749 MB / 0.5283 GB, free: 7.555 MB / 430.1 MB
Notification: Performance of postOpt solveSimpleEquations (initialization): time 0.001598/0.5332, allocations: 399.2 kB / 0.5287 GB, free: 7.164 MB / 430.1 MB
Notification: Performance of postOpt calculateStrongComponentJacobians (initialization): time 0.002542/0.5357, allocations: 2.27 MB / 0.5309 GB, free: 4.816 MB / 430.1 MB
Notification: Performance of postOpt simplifyAllExpressions (initialization): time 0.001854/0.5376, allocations: 127.8 kB / 0.531 GB, free: 4.691 MB / 430.1 MB
Notification: Performance of postOpt collapseArrayExpressions (initialization): time 0.0002631/0.5378, allocations: 120 kB / 0.5311 GB, free: 4.574 MB / 430.1 MB
Notification: Model statistics after passing the back-end for initialization:
 * Number of independent subsystems: 83
 * Number of states: 0 ()
 * Number of discrete variables: 186 ($PRE.tankController.normal.T1.enableFire,$PRE.tankController.normal.T3.enableFire,$PRE.tankController.normal.T2.enableFire,$PRE.tankController.normal.T4.enableFire,$PRE.tankController.T1.enableFire,$PRE.tankController.T2.enableFire,$PRE.tankController.T3.enableFire,$PRE.tankController.T4.enableFire,$PRE.tankController.T5.enableFire,$PRE.tankController.T6.enableFire,$PRE.start.pre_reset[1],$PRE.start.pre_reset[2],$PRE.stop.pre_reset[1],$PRE.stop.pre_reset[2],$PRE.shut.pre_reset[1],$PRE.shut.pre_reset[2],tankController.T6.t_start,$PRE.tankController.T6.t_start,tankController.T5.t_start,$PRE.tankController.T5.t_start,tankController.T4.t_start,$PRE.tankController.T4.t_start,tankController.T3.t_start,$PRE.tankController.T3.t_start,tankController.T2.t_start,$PRE.tankController.T2.t_start,tankController.T1.t_start,$PRE.tankController.T1.t_start,tankController.normal.T3.t_start,$PRE.tankController.normal.T3.t_start,tankController.normal.T1.t_start,$PRE.tankController.normal.T1.t_start,$PRE.shut.table.combiTimeTable.nextTimeEvent,$whenCondition6,$PRE.stop.table.combiTimeTable.nextTimeEvent,$whenCondition5,$PRE.start.table.combiTimeTable.nextTimeEvent,$whenCondition4,shut.pre_reset[2],shut.pre_reset[1],shut.table.combiTimeTable.nextTimeEventScaled,$PRE.shut.table.combiTimeTable.nextTimeEventScaled,shut.table.combiTimeTable.nextTimeEvent,shut.table.y,$PRE.shut.table.y,$PRE.shut.reset[2],$PRE.shut.reset[1],$whenCondition9,$whenCondition7,$whenCondition8,stop.pre_reset[2],stop.pre_reset[1],stop.table.combiTimeTable.nextTimeEventScaled,$PRE.stop.table.combiTimeTable.nextTimeEventScaled,stop.table.combiTimeTable.nextTimeEvent,stop.table.y,$PRE.stop.table.y,$PRE.stop.reset[2],$PRE.stop.reset[1],$whenCondition12,$whenCondition10,$whenCondition11,start.pre_reset[2],start.pre_reset[1],start.table.combiTimeTable.nextTimeEventScaled,$PRE.start.table.combiTimeTable.nextTimeEventScaled,start.table.combiTimeTable.nextTimeEvent,start.table.y,$PRE.start.table.y,$PRE.start.reset[2],$PRE.start.reset[1],$whenCondition15,$whenCondition13,$whenCondition14,tankController.stateGraphRoot.resume,tankController.stateGraphRoot.suspend,tankController.normal.T4.condition,tankController.normal.T2.condition,tank2.inFlow[2],tank2.inFlow[1],tank2.regularFlow[2],tank2.regularFlow[1],tank1.inFlow[2],tank1.inFlow[1],tank1.regularFlow[2],tank1.regularFlow[1],shut.on,$PRE.shut.on,shut.reset[2],shut.reset[1],stop.on,$PRE.stop.on,stop.reset[2],stop.reset[1],start.on,$PRE.start.on,start.reset[2],start.reset[1],tankController.stateGraphRoot.activeSteps,tankController.valve3,tankController.valve2,tankController.T6.enableFire,tankController.T6.localCondition,tankController.emptyTanks.oldActive,$PRE.tankController.emptyTanks.oldActive,tankController.emptyTanks.newActive,$PRE.tankController.emptyTanks.newActive,tankController.emptyTanks.localActive,$PRE.tankController.emptyTanks.localActive,tankController.emptyTanks.active,tankController.T5.enableFire,tankController.T4.enableFire,tankController.s2.oldActive,$PRE.tankController.s2.oldActive,tankController.s2.newActive,$PRE.tankController.s2.newActive,tankController.s2.outPort[2].available,tankController.s2.localActive,$PRE.tankController.s2.localActive,tankController.s2.active,tankController.T3.enableFire,tankController.T2.enableFire,tankController.T2.localCondition,tankController.T1.enableFire,tankController.normal.T4.t_start,$PRE.tankController.normal.T4.t_start,tankController.normal.T4.fire,tankController.normal.T4.enableFire,tankController.normal.wait2.oldActive,$PRE.tankController.normal.wait2.oldActive,tankController.normal.wait2.newActive,$PRE.tankController.normal.wait2.newActive,tankController.normal.wait2.localActive,$PRE.tankController.normal.wait2.localActive,tankController.normal.wait2.active,tankController.normal.T2.t_start,$PRE.tankController.normal.T2.t_start,tankController.normal.T2.fire,tankController.normal.T2.enableFire,tankController.normal.wait1.oldActive,$PRE.tankController.normal.wait1.oldActive,tankController.normal.wait1.newActive,$PRE.tankController.normal.wait1.newActive,tankController.normal.wait1.localActive,$PRE.tankController.normal.wait1.localActive,tankController.normal.wait1.active,tankController.normal.emptyTank2.oldActive,$PRE.tankController.normal.emptyTank2.oldActive,tankController.normal.emptyTank2.newActive,$PRE.tankController.normal.emptyTank2.newActive,tankController.normal.emptyTank2.localActive,$PRE.tankController.normal.emptyTank2.localActive,tankController.normal.emptyTank2.active,tankController.normal.T3.enableFire,tankController.normal.T3.localCondition,tankController.normal.fillTank2.oldActive,$PRE.tankController.normal.fillTank2.oldActive,tankController.normal.fillTank2.newActive,$PRE.tankController.normal.fillTank2.newActive,tankController.normal.fillTank2.localActive,$PRE.tankController.normal.fillTank2.localActive,tankController.normal.fillTank2.active,tankController.normal.T1.enableFire,tankController.normal.T1.localCondition,tankController.normal.fillTank1.oldActive,$PRE.tankController.normal.fillTank1.oldActive,tankController.normal.fillTank1.newActive,$PRE.tankController.normal.fillTank1.newActive,tankController.normal.fillTank1.localActive,$PRE.tankController.normal.fillTank1.localActive,tankController.normal.fillTank1.active,tankController.normal.activeSteps,tankController.normal.newActive,$PRE.tankController.normal.newActive,tankController.normal.active,tankController.s1.oldActive,$PRE.tankController.s1.oldActive,tankController.s1.newActive,$PRE.tankController.s1.newActive,tankController.s1.inPort[2].occupied,tankController.s1.localActive,$PRE.tankController.s1.localActive,tankController.s1.active,$whenCondition1,$whenCondition2,$whenCondition3)
 * Number of discrete states: 0 ()
 * Number of clocked states: 0 ()
 * Top-level inputs: 0
Notification: Strong component statistics for initialization (323):
 * Single equations (assignments): 317
 * Array equations: 0
 * Algorithm blocks: 3
 * Record equations: 0
 * When equations: 0
 * If-equations: 0
 * Equation systems (not torn): 0
 * Torn equation systems: 3
 * Mixed (continuous/discrete) equation systems: 0
Notification: Torn system details for strict tearing set:
 * Linear torn systems (#iteration vars, #inner vars, density): 0 systems
 * Non-linear torn systems (#iteration vars, #inner vars): 3 systems
   {(2,3), (4,4), (2,3)}
Notification: Performance of prepare postOptimizeDAE: time 0.00147/0.5393, allocations: 0.8103 MB / 0.5319 GB, free: 3.73 MB / 430.1 MB
Notification: Performance of postOpt lateInlineFunction (simulation): time 0.0005135/0.5398, allocations: 222.7 kB / 0.5321 GB, free: 3.512 MB / 430.1 MB
Notification: Performance of postOpt wrapFunctionCalls (simulation): time 0.006085/0.5459, allocations: 3.017 MB / 0.5351 GB, free: 468 kB / 430.1 MB
Notification: Performance of postOpt inlineArrayEqn (simulation): time 3.09e-05/0.5459, allocations: 20 kB / 0.5351 GB, free: 448 kB / 430.1 MB
Notification: Performance of postOpt constantLinearSystem (simulation): time 1.206e-05/0.5459, allocations: 7.984 kB / 0.5351 GB, free: 440 kB / 430.1 MB
Notification: Performance of postOpt simplifysemiLinear (simulation): time 2.447e-05/0.546, allocations: 11.97 kB / 0.5351 GB, free: 428 kB / 430.1 MB
Notification: Performance of postOpt removeSimpleEquations (simulation): time 0.01013/0.5561, allocations: 5.395 MB / 0.5404 GB, free: 10.93 MB / 446.1 MB
Notification: Performance of postOpt simplifyComplexFunction (simulation): time 1.442e-05/0.5561, allocations: 4 kB / 0.5404 GB, free: 10.93 MB / 446.1 MB
Notification: Performance of postOpt solveSimpleEquations (simulation): time 0.001122/0.5572, allocations: 247.5 kB / 0.5406 GB, free: 10.69 MB / 446.1 MB
Notification: Performance of postOpt tearingSystem (simulation): time 0.001228/0.5585, allocations: 0.5606 MB / 0.5412 GB, free: 10.12 MB / 446.1 MB
Notification: Performance of postOpt inputDerivativesUsed (simulation): time 0.0002086/0.5587, allocations: 63.95 kB / 0.5412 GB, free: 10.05 MB / 446.1 MB
Notification: Performance of postOpt calculateStrongComponentJacobians (simulation): time 0.002441/0.5611, allocations: 2.243 MB / 0.5434 GB, free: 7.734 MB / 446.1 MB
Notification: Performance of postOpt calculateStateSetsJacobians (simulation): time 5.851e-06/0.5611, allocations: 4 kB / 0.5434 GB, free: 7.73 MB / 446.1 MB
Notification: Performance of postOpt symbolicJacobian (simulation): time 0.008404/0.5695, allocations: 4.184 MB / 0.5475 GB, free: 3.477 MB / 446.1 MB
Notification: Performance of postOpt removeConstants (simulation): time 0.001372/0.5709, allocations: 0.5306 MB / 0.548 GB, free: 2.926 MB / 446.1 MB
Notification: Performance of postOpt simplifyTimeIndepFuncCalls (simulation): time 0.0005008/0.5714, allocations: 75.97 kB / 0.5481 GB, free: 2.852 MB / 446.1 MB
Notification: Performance of postOpt simplifyAllExpressions (simulation): time 0.001262/0.5726, allocations: 99.92 kB / 0.5482 GB, free: 2.754 MB / 446.1 MB
Notification: Performance of postOpt findZeroCrossings (simulation): time 0.0005655/0.5732, allocations: 253.6 kB / 0.5484 GB, free: 2.508 MB / 446.1 MB
Notification: Performance of postOpt collapseArrayExpressions (simulation): time 0.0002162/0.5734, allocations: 91.95 kB / 0.5485 GB, free: 2.418 MB / 446.1 MB
Notification: Performance of sorting global known variables: time 0.001681/0.5751, allocations: 1.059 MB / 0.5495 GB, free: 1.363 MB / 446.1 MB
Notification: Performance of sort global known variables: time 6e-08/0.5751, allocations: 0 / 0.5495 GB, free: 1.363 MB / 446.1 MB
Notification: Performance of remove unused functions: time 0.002597/0.5777, allocations: 0.6947 MB / 0.5502 GB, free: 0.668 MB / 446.1 MB
Notification: Model statistics after passing the back-end for simulation:
 * Number of independent subsystems: 9
 * Number of states: 4 (tank1.level,tank1.medium.T,tank2.level,tank2.medium.T)
 * Number of discrete variables: 113 (tankController.T3.enableFire,tankController.emptyTanks.localActive,tankController.s2.localActive,tankController.normal.T4.enableFire,tankController.normal.wait2.localActive,tankController.normal.T2.enableFire,tankController.normal.wait1.localActive,tankController.normal.emptyTank2.localActive,tankController.normal.fillTank2.localActive,tankController.normal.fillTank1.active,tankController.s1.localActive,$whenCondition6,$whenCondition5,$whenCondition4,$whenCondition3,$whenCondition2,$whenCondition1,$whenCondition8,$whenCondition7,$whenCondition9,$whenCondition11,$whenCondition10,$whenCondition12,$whenCondition14,$whenCondition13,$whenCondition15,tankController.s1.active,tankController.s1.inPort[2].occupied,tankController.s1.newActive,tankController.s1.oldActive,tankController.normal.active,tankController.normal.newActive,tankController.normal.activeSteps,tankController.normal.fillTank1.localActive,tankController.normal.fillTank1.newActive,tankController.normal.fillTank1.oldActive,tankController.normal.T1.localCondition,tankController.normal.T1.enableFire,tankController.normal.fillTank2.active,tankController.normal.fillTank2.newActive,tankController.normal.fillTank2.oldActive,tankController.normal.T3.localCondition,tankController.normal.T3.enableFire,tankController.normal.emptyTank2.active,tankController.normal.emptyTank2.newActive,tankController.normal.emptyTank2.oldActive,tankController.normal.wait1.active,tankController.normal.wait1.newActive,tankController.normal.wait1.oldActive,tankController.normal.T2.fire,tankController.normal.T2.t_start,tankController.normal.wait2.active,tankController.normal.wait2.newActive,tankController.normal.wait2.oldActive,tankController.normal.T4.fire,tankController.normal.T4.t_start,tankController.T1.enableFire,tankController.T2.localCondition,tankController.T2.enableFire,tankController.s2.active,tankController.s2.outPort[2].available,tankController.s2.newActive,tankController.s2.oldActive,tankController.T4.enableFire,tankController.T5.enableFire,tankController.emptyTanks.active,tankController.emptyTanks.newActive,tankController.emptyTanks.oldActive,tankController.T6.localCondition,tankController.T6.enableFire,tankController.valve2,tankController.valve3,tankController.stateGraphRoot.activeSteps,start.reset[1],start.reset[2],start.on,start.table.y,start.table.combiTimeTable.nextTimeEvent,start.table.combiTimeTable.nextTimeEventScaled,start.pre_reset[1],start.pre_reset[2],stop.reset[1],stop.reset[2],stop.on,stop.table.y,stop.table.combiTimeTable.nextTimeEvent,stop.table.combiTimeTable.nextTimeEventScaled,stop.pre_reset[1],stop.pre_reset[2],shut.reset[1],shut.reset[2],shut.on,shut.table.y,shut.table.combiTimeTable.nextTimeEvent,shut.table.combiTimeTable.nextTimeEventScaled,shut.pre_reset[1],shut.pre_reset[2],tank1.regularFlow[1],tank1.regularFlow[2],tank1.inFlow[1],tank1.inFlow[2],tank2.regularFlow[1],tank2.regularFlow[2],tank2.inFlow[1],tank2.inFlow[2],tankController.normal.T1.t_start,tankController.normal.T3.t_start,tankController.T1.t_start,tankController.T2.t_start,tankController.T3.t_start,tankController.T4.t_start,tankController.T5.t_start,tankController.T6.t_start)
 * Number of discrete states: 50 (tankController.T6.t_start,tankController.T5.t_start,tankController.T4.t_start,tankController.T3.t_start,tankController.T2.t_start,tankController.T1.t_start,tankController.normal.T3.t_start,tankController.normal.T1.t_start,shut.table.combiTimeTable.nextTimeEvent,stop.table.combiTimeTable.nextTimeEvent,start.table.combiTimeTable.nextTimeEvent,tankController.s1.newActive,tankController.normal.fillTank1.newActive,tankController.normal.fillTank2.newActive,tankController.normal.emptyTank2.newActive,tankController.normal.wait1.newActive,tankController.normal.wait2.newActive,tankController.normal.newActive,tankController.s2.newActive,tankController.emptyTanks.newActive,shut.table.combiTimeTable.nextTimeEventScaled,$whenCondition9,shut.on,$whenCondition8,$whenCondition7,shut.pre_reset[2],shut.pre_reset[1],shut.reset[1],shut.reset[2],shut.table.y,stop.table.combiTimeTable.nextTimeEventScaled,$whenCondition12,stop.on,$whenCondition11,$whenCondition10,stop.pre_reset[2],stop.pre_reset[1],stop.reset[1],stop.reset[2],stop.table.y,start.table.combiTimeTable.nextTimeEventScaled,$whenCondition15,start.on,$whenCondition14,$whenCondition13,start.pre_reset[2],start.pre_reset[1],start.reset[1],start.reset[2],start.table.y)
 * Number of clocked states: 0 ()
 * Top-level inputs: 0
Notification: Strong component statistics for simulation (212):
 * Single equations (assignments): 176
 * Array equations: 0
 * Algorithm blocks: 3
 * Record equations: 6
 * When equations: 24
 * If-equations: 0
 * Equation systems (not torn): 0
 * Torn equation systems: 3
 * Mixed (continuous/discrete) equation systems: 0
Notification: Torn system details for strict tearing set:
 * Linear torn systems (#iteration vars, #inner vars, density): 0 systems
 * Non-linear torn systems (#iteration vars, #inner vars): 3 systems
   {(2,3), (4,4), (2,3)}
Notification: Performance of Backend phase and start with SimCode phase: time 0.0026/0.5803, allocations: 0.8533 MB / 0.5511 GB, free: 15.96 MB / 462.1 MB
Notification: Performance of simCode: created initialization part: time 0.00593/0.5862, allocations: 2.627 MB / 0.5536 GB, free: 13.3 MB / 462.1 MB
Notification: Performance of simCode: created event and clocks part: time 8.977e-06/0.5862, allocations: 4.125 kB / 0.5536 GB, free: 13.29 MB / 462.1 MB
Notification: Performance of simCode: created simulation system equations: time 0.003207/0.5895, allocations: 1.45 MB / 0.555 GB, free: 11.81 MB / 462.1 MB
Notification: Performance of simCode: created of all other equations (e.g. parameter, nominal, assert, etc): time 0.00382/0.5933, allocations: 0.761 MB / 0.5558 GB, free: 11.07 MB / 462.1 MB
Notification: Performance of simCode: created linear, non-linear and system jacobian parts: time 0.009298/0.6026, allocations: 4.572 MB / 0.5603 GB, free: 6.426 MB / 462.1 MB
Notification: Performance of simCode: some other stuff during SimCode phase: time 0.001398/0.604, allocations: 1.583 MB / 0.5618 GB, free: 4.809 MB / 462.1 MB
Notification: Performance of simCode: all other stuff during SimCode phase: time 0.0009463/0.6049, allocations: 235.3 kB / 0.562 GB, free: 4.578 MB / 462.1 MB
Notification: Performance of SimCode: time 1.623e-06/0.6049, allocations: 0 / 0.562 GB, free: 4.578 MB / 462.1 MB
Notification: Performance of Templates: time 0.09006/0.695, allocations: 68.09 MB / 0.6285 GB, free: 0.5078 MB / 0.5137 GB
"
[Timeout remaining time 659]
make -j1 -f Modelica_trunk_Modelica.Fluid.Examples.ControlledTankSystem.ControlledTanks.makefile [Timeout 660]
(rm -f Modelica_trunk_Modelica.Fluid.Examples.ControlledTankSystem.ControlledTanks.pipe ; mkfifo Modelica_trunk_Modelica.Fluid.Examples.ControlledTankSystem.ControlledTanks.pipe ; head -c 1048576 < Modelica_trunk_Modelica.Fluid.Examples.ControlledTankSystem.ControlledTanks.pipe >> ../files/Modelica_trunk_Modelica.Fluid.Examples.ControlledTankSystem.ControlledTanks.sim & ./Modelica_trunk_Modelica.Fluid.Examples.ControlledTankSystem.ControlledTanks  -abortSlowSimulation -alarm=480  -emit_protected -lv LOG_STATS > Modelica_trunk_Modelica.Fluid.Examples.ControlledTankSystem.ControlledTanks.pipe 2>&1) [Timeout 480]
diffSimulationResults("Modelica_trunk_Modelica.Fluid.Examples.ControlledTankSystem.ControlledTanks_res.mat","/var/lib/jenkins1/ws/OpenModelicaLibraryTestingWork_2/Reference-modelica.org/ReferenceResults/MAP-LIB_ReferenceResults/v4.1.0/Modelica/Fluid/Examples/ControlledTankSystem/ControlledTanks/ControlledTanks.csv","/var/lib/jenkins1/ws/OpenModelicaLibraryTestingWork_2/OpenModelicaLibraryTesting/files/Modelica_trunk_Modelica.Fluid.Examples.ControlledTankSystem.ControlledTanks.diff",relTol=0.003,relTolDiffMinMax=0.003,rangeDelta=0.001) [Timeout 660]
""
[Timeout remaining time 660]
Reference file matches
[Calling sys.exit(0), Time elapsed: 13.655503751011565]