Running: ./testmodel.py --libraries=/var/lib/hudson/saved_omc/libraries/.openmodelica/libraries/ --ompython_omhome=/usr ModelicaTest_3.2.2_ModelicaTest.Fluid.TestComponents.Sensors.TestTemperature2.conf.json
Using package ModelicaTest with version 3.2.2 (/var/lib/hudson/saved_omc/libraries/.openmodelica/libraries/ModelicaTest 3.2.2+maint.om/package.mo)
Using package ModelicaServices with version 3.2.2 (/var/lib/hudson/saved_omc/libraries/.openmodelica/libraries/ModelicaServices 3.2.2+maint.om/package.mo)
Using package Modelica with version 3.2.2 (/var/lib/hudson/saved_omc/libraries/.openmodelica/libraries/Modelica 3.2.2+maint.om/package.mo)
Using package Complex with version 3.2.2 (/var/lib/hudson/saved_omc/libraries/.openmodelica/libraries/Complex 3.2.2+maint.om/package.mo)
Running command: translateModel(ModelicaTest.Fluid.TestComponents.Sensors.TestTemperature2,tolerance=1e-06,outputFormat="mat",numberOfIntervals=5000,variableFilter="time|Tmix1_1.T|Tmix1_2.T|Tmix2.T",fileNamePrefix="ModelicaTest_3.2.2_ModelicaTest.Fluid.TestComponents.Sensors.TestTemperature2")
Notification: Performance of loadFile(/var/lib/hudson/saved_omc/libraries/.openmodelica/libraries/Complex 3.2.2+maint.om/package.mo): time 0.003851/0.003858, allocations: 371.4 kB / 15.97 MB, free: 6.199 MB / 13.93 MB
Notification: Performance of loadFile(/var/lib/hudson/saved_omc/libraries/.openmodelica/libraries/Modelica 3.2.2+maint.om/package.mo): time 4.134/4.134, allocations: 388.9 MB / 405.6 MB, free: 9.578 MB / 346.7 MB
Notification: Performance of loadFile(/var/lib/hudson/saved_omc/libraries/.openmodelica/libraries/ModelicaServices 3.2.2+maint.om/package.mo): time 0.003433/0.003432, allocations: 223.3 kB / 451 MB, free: 145 MB / 346.7 MB
Notification: Performance of loadFile(/var/lib/hudson/saved_omc/libraries/.openmodelica/libraries/ModelicaTest 3.2.2+maint.om/package.mo): time 0.4978/0.4978, allocations: 80.03 MB / 0.5627 GB, free: 19.76 MB / 346.7 MB
Notification: Performance of FrontEnd - loaded program: time 0.0004768/0.000477, allocations: 12 kB / 0.6265 GB, free: 96.55 MB / 346.7 MB
Notification: Performance of FrontEnd - Absyn->SCode: time 0.1057/0.1062, allocations: 54.87 MB / 0.6801 GB, free: 41.68 MB / 346.7 MB
Notification: Performance of NFInst.instantiate(ModelicaTest.Fluid.TestComponents.Sensors.TestTemperature2): time 0.4624/0.5686, allocations: 70.2 MB / 0.7487 GB, free: 12.24 MB / 346.7 MB
Notification: Performance of NFInst.instExpressions: time 0.05457/0.6233, allocations: 31.41 MB / 0.7793 GB, free: 4.367 MB / 362.7 MB
Notification: Performance of NFInst.updateImplicitVariability: time 0.002703/0.626, allocations: 59.06 kB / 0.7794 GB, free: 4.336 MB / 362.7 MB
Notification: Performance of NFTyping.typeComponents: time 0.004134/0.6302, allocations: 0.8338 MB / 0.7802 GB, free: 3.625 MB / 362.7 MB
[/var/lib/hudson/saved_omc/libraries/.openmodelica/libraries/Modelica 3.2.2+maint.om/Fluid/Sources.mo:826:36-827:54:writable] Warning: 'each' used when modifying non-array element m_flow.
[/var/lib/hudson/saved_omc/libraries/.openmodelica/libraries/Modelica 3.2.2+maint.om/Fluid/Sources.mo:824:36-825:54:writable] Warning: 'each' used when modifying non-array element m_flow.
[/var/lib/hudson/saved_omc/libraries/.openmodelica/libraries/Modelica 3.2.2+maint.om/Fluid/Sources.mo:772:36-773:54:writable] Warning: 'each' used when modifying non-array element m_flow.
[/var/lib/hudson/saved_omc/libraries/.openmodelica/libraries/Modelica 3.2.2+maint.om/Fluid/Sources.mo:770:36-771:54:writable] Warning: 'each' used when modifying non-array element m_flow.
[/var/lib/hudson/saved_omc/libraries/.openmodelica/libraries/Modelica 3.2.2+maint.om/Fluid/Sources.mo:826:36-827:54:writable] Warning: 'each' used when modifying non-array element m_flow.
[/var/lib/hudson/saved_omc/libraries/.openmodelica/libraries/Modelica 3.2.2+maint.om/Fluid/Sources.mo:824:36-825:54:writable] Warning: 'each' used when modifying non-array element m_flow.
[/var/lib/hudson/saved_omc/libraries/.openmodelica/libraries/Modelica 3.2.2+maint.om/Fluid/Sources.mo:772:36-773:54:writable] Warning: 'each' used when modifying non-array element m_flow.
[/var/lib/hudson/saved_omc/libraries/.openmodelica/libraries/Modelica 3.2.2+maint.om/Fluid/Sources.mo:770:36-771:54:writable] Warning: 'each' used when modifying non-array element m_flow.
Notification: Performance of NFTyping.typeBindings: time 0.01897/0.6492, allocations: 4.308 MB / 0.7844 GB, free: 336 kB / 362.7 MB
Notification: Performance of NFTyping.typeClassSections: time 0.02212/0.6714, allocations: 5.105 MB / 0.7894 GB, free: 12.35 MB / 378.7 MB
Notification: Performance of NFFlatten.flatten: time 0.01328/0.6847, allocations: 6.022 MB / 0.7953 GB, free: 6.309 MB / 378.7 MB
Notification: Performance of NFFlatten.resolveConnections: time 0.004071/0.6888, allocations: 1.057 MB / 0.7963 GB, free: 5.234 MB / 378.7 MB
Notification: Performance of NFEvalConstants.evaluate: time 0.02294/0.7118, allocations: 7.327 MB / 0.8035 GB, free: 13.9 MB / 394.7 MB
Notification: Performance of NFSimplifyModel.simplify: time 0.004215/0.7161, allocations: 1.545 MB / 0.805 GB, free: 12.35 MB / 394.7 MB
Notification: Performance of NFPackage.collectConstants: time 0.0008911/0.7171, allocations: 100 kB / 0.8051 GB, free: 12.25 MB / 394.7 MB
Notification: Performance of NFFlatten.collectFunctions: time 0.02716/0.7443, allocations: 6.66 MB / 0.8116 GB, free: 5.582 MB / 394.7 MB
Notification: Performance of NFScalarize.scalarize: time 0.001553/0.7459, allocations: 0.6193 MB / 0.8122 GB, free: 4.961 MB / 394.7 MB
Notification: Performance of NFVerifyModel.verify: time 0.001023/0.7469, allocations: 404.8 kB / 0.8126 GB, free: 4.559 MB / 394.7 MB
Notification: Performance of NFConvertDAE.convert: time 0.01123/0.7582, allocations: 4.611 MB / 0.8171 GB, free: 15.94 MB / 410.7 MB
Notification: Performance of FrontEnd - DAE generated: time 6.271e-06/0.7582, allocations: 0 / 0.8171 GB, free: 15.94 MB / 410.7 MB
Notification: Performance of FrontEnd: time 2.695e-06/0.7582, allocations: 0 / 0.8171 GB, free: 15.94 MB / 410.7 MB
Notification: Performance of Transformations before backend: time 6.64e-05/0.7583, allocations: 0 / 0.8171 GB, free: 15.94 MB / 410.7 MB
Notification: Model statistics after passing the front-end and creating the data structures used by the back-end:
 * Number of equations: 441
 * Number of variables: 441
Notification: Performance of Generate backend data structure: time 0.009673/0.768, allocations: 2.474 MB / 0.8195 GB, free: 13.41 MB / 410.7 MB
Notification: Performance of prepare preOptimizeDAE: time 5.205e-05/0.7681, allocations: 9.359 kB / 0.8195 GB, free: 13.4 MB / 410.7 MB
Notification: Performance of preOpt normalInlineFunction (simulation): time 0.009103/0.7772, allocations: 0.8408 MB / 0.8203 GB, free: 12.55 MB / 410.7 MB
Notification: Performance of preOpt evaluateParameters (simulation): time 0.003152/0.7804, allocations: 1.052 MB / 0.8213 GB, free: 11.46 MB / 410.7 MB
Notification: Performance of preOpt simplifyIfEquations (simulation): time 0.0005476/0.781, allocations: 464.4 kB / 0.8218 GB, free: 10.95 MB / 410.7 MB
Notification: Performance of preOpt expandDerOperator (simulation): time 0.0004444/0.7814, allocations: 168 kB / 0.8219 GB, free: 10.79 MB / 410.7 MB
Notification: Performance of preOpt clockPartitioning (simulation): time 0.01157/0.793, allocations: 3.185 MB / 0.8251 GB, free: 7.34 MB / 410.7 MB
Notification: Performance of preOpt findStateOrder (simulation): time 8.029e-05/0.7931, allocations: 11.88 kB / 0.8251 GB, free: 7.328 MB / 410.7 MB
Notification: Performance of preOpt replaceEdgeChange (simulation): time 0.0003917/0.7936, allocations: 84 kB / 0.8251 GB, free: 7.246 MB / 410.7 MB
Notification: Performance of preOpt inlineArrayEqn (simulation): time 0.000165/0.7937, allocations: 86.7 kB / 0.8252 GB, free: 7.16 MB / 410.7 MB
Notification: Performance of preOpt removeEqualRHS (simulation): time 0.01229/0.806, allocations: 2.785 MB / 0.8279 GB, free: 4.367 MB / 410.7 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.02784/0.8339, allocations: 15.54 MB / 0.8431 GB, free: 3.73 MB / 426.7 MB
Notification: Performance of preOpt comSubExp (simulation): time 0.006277/0.8403, allocations: 1.304 MB / 0.8444 GB, free: 2.422 MB / 426.7 MB
Notification: Performance of preOpt resolveLoops (simulation): time 0.001962/0.8423, allocations: 483.3 kB / 0.8449 GB, free: 1.949 MB / 426.7 MB
Notification: Performance of preOpt evalFunc (simulation): time 0.08485/0.9271, allocations: 18.58 MB / 0.863 GB, free: 13.87 MB / 458.7 MB
Notification: Performance of preOpt encapsulateWhenConditions (simulation): time 6.928e-05/0.9273, allocations: 47.56 kB / 0.863 GB, free: 13.81 MB / 458.7 MB
Notification: Performance of pre-optimization done (n=101): time 3.777e-06/0.9273, allocations: 0 / 0.863 GB, free: 13.81 MB / 458.7 MB
Notification: Performance of matching and sorting (n=117): time 0.02677/0.9541, allocations: 4.941 MB / 0.8679 GB, free: 8.797 MB / 458.7 MB
Notification: Performance of inlineWhenForInitialization (initialization): time 0.000112/0.9542, allocations: 167.2 kB / 0.868 GB, free: 8.598 MB / 458.7 MB
Notification: Performance of selectInitializationVariablesDAE (initialization): time 0.002453/0.9567, allocations: 1.211 MB / 0.8692 GB, free: 7.379 MB / 458.7 MB
Notification: Performance of collectPreVariables (initialization): time 0.0002683/0.957, allocations: 45.7 kB / 0.8693 GB, free: 7.328 MB / 458.7 MB
Notification: Performance of collectInitialEqns (initialization): time 0.001251/0.9583, allocations: 0.978 MB / 0.8702 GB, free: 6.332 MB / 458.7 MB
Notification: Performance of collectInitialBindings (initialization): time 0.0006971/0.959, allocations: 422.2 kB / 0.8706 GB, free: 5.914 MB / 458.7 MB
Notification: Performance of simplifyInitialFunctions (initialization): time 0.000168/0.9592, allocations: 52 kB / 0.8707 GB, free: 5.863 MB / 458.7 MB
Notification: Performance of setup shared object (initialization): time 0.0003543/0.9595, allocations: 451.6 kB / 0.8711 GB, free: 5.414 MB / 458.7 MB
Notification: Performance of preBalanceInitialSystem (initialization): time 0.002671/0.9622, allocations: 0.641 MB / 0.8717 GB, free: 4.77 MB / 458.7 MB
Notification: Performance of partitionIndependentBlocks (initialization): time 0.004066/0.9663, allocations: 1.953 MB / 0.8736 GB, free: 2.164 MB / 458.7 MB
Notification: Performance of analyzeInitialSystem (initialization): time 0.003677/0.97, allocations: 0.9902 MB / 0.8746 GB, free: 1.172 MB / 458.7 MB
Notification: Performance of solveInitialSystemEqSystem (initialization): time 4.518e-05/0.9701, allocations: 12 kB / 0.8746 GB, free: 1.16 MB / 458.7 MB
Notification: Performance of matching and sorting (n=305) (initialization): time 0.01009/0.9802, allocations: 2.792 MB / 0.8773 GB, free: 14.35 MB / 474.7 MB
Notification: Performance of prepare postOptimizeDAE: time 7.166e-05/0.9804, allocations: 24 kB / 0.8774 GB, free: 14.32 MB / 474.7 MB
Notification: Performance of postOpt simplifyComplexFunction (initialization): time 8.17e-05/0.9804, allocations: 44 kB / 0.8774 GB, free: 14.28 MB / 474.7 MB
Notification: Performance of postOpt tearingSystem (initialization): time 0.002152/0.9826, allocations: 411.8 kB / 0.8778 GB, free: 13.87 MB / 474.7 MB
Notification: Performance of postOpt solveSimpleEquations (initialization): time 0.003533/0.9862, allocations: 0.5459 MB / 0.8783 GB, free: 13.32 MB / 474.7 MB
Notification: Performance of postOpt calculateStrongComponentJacobians (initialization): time 0.003274/0.9895, allocations: 2.724 MB / 0.881 GB, free: 10.49 MB / 474.7 MB
Notification: Performance of postOpt simplifyAllExpressions (initialization): time 0.00299/0.9926, allocations: 199.8 kB / 0.8812 GB, free: 10.3 MB / 474.7 MB
Notification: Performance of postOpt collapseArrayExpressions (initialization): time 0.0003605/0.993, allocations: 144 kB / 0.8813 GB, free: 10.16 MB / 474.7 MB
Notification: Model statistics after passing the back-end for initialization:
 * Number of independent subsystems: 205
 * Number of states: 0 ()
 * Number of discrete variables: 28 (sink2.medium.phase,source2.medium.phase,sink1.medium.phase,source1.medium.phase,volume1_1.heatTransfer.states[1].phase,volume1_2.heatTransfer.states[1].phase,volume2_1.heatTransfer.states[1].phase,volume2_2.heatTransfer.states[1].phase,volume1_1.regularFlow[1],volume1_1.regularFlow[2],volume1_1.regularFlow[3],volume1_2.regularFlow[1],volume1_2.regularFlow[2],volume1_2.regularFlow[3],volume2_1.regularFlow[1],volume2_1.regularFlow[2],volume2_2.regularFlow[1],volume2_2.regularFlow[2],volume2_2.inFlow[2],volume2_2.inFlow[1],volume2_1.inFlow[2],volume2_1.inFlow[1],volume1_2.inFlow[3],volume1_2.inFlow[2],volume1_2.inFlow[1],volume1_1.inFlow[3],volume1_1.inFlow[2],volume1_1.inFlow[1])
 * Number of discrete states: 0 ()
 * Number of clocked states: 0 ()
 * Top-level inputs: 0
Notification: Strong component statistics for initialization (277):
 * Single equations (assignments): 273
 * 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: 4
 * Mixed (continuous/discrete) equation systems: 0
Notification: Torn system details for strict tearing set:
 * Linear torn systems: 0
 * Non-linear torn systems: 4 {1 7,1 7,1 7,1 7}
Notification: Performance of prepare postOptimizeDAE: time 0.001353/0.9943, allocations: 0.5474 MB / 0.8818 GB, free: 9.598 MB / 474.7 MB
Notification: Performance of postOpt lateInlineFunction (simulation): time 0.0004397/0.9948, allocations: 150.2 kB / 0.882 GB, free: 9.449 MB / 474.7 MB
Notification: Performance of postOpt wrapFunctionCalls (simulation): time 0.01193/1.007, allocations: 4.686 MB / 0.8866 GB, free: 4.703 MB / 474.7 MB
Notification: Performance of postOpt simplifysemiLinear (simulation): time 2.929e-05/1.007, allocations: 3.984 kB / 0.8866 GB, free: 4.699 MB / 474.7 MB
Notification: Performance of postOpt simplifyComplexFunction (simulation): time 7.144e-06/1.007, allocations: 0 / 0.8866 GB, free: 4.699 MB / 474.7 MB
Notification: Performance of postOpt removeConstants (simulation): time 0.001104/1.008, allocations: 445.6 kB / 0.887 GB, free: 4.242 MB / 474.7 MB
Notification: Performance of postOpt simplifyTimeIndepFuncCalls (simulation): time 0.00054/1.009, allocations: 28 kB / 0.887 GB, free: 4.215 MB / 474.7 MB
Notification: Performance of postOpt simplifyAllExpressions (simulation): time 0.002036/1.011, allocations: 155.7 kB / 0.8872 GB, free: 4.062 MB / 474.7 MB
Notification: Performance of postOpt findZeroCrossings (simulation): time 0.0002573/1.011, allocations: 85.17 kB / 0.8872 GB, free: 3.98 MB / 474.7 MB
Notification: Performance of postOpt createDAEmodeBDAE (simulation): time 0.009317/1.02, allocations: 2.721 MB / 0.8899 GB, free: 1.207 MB / 474.7 MB
Notification: Performance of postOpt detectDAEmodeSparsePattern (simulation): time 0.009423/1.03, allocations: 3.554 MB / 0.8934 GB, free: 13.6 MB / 490.7 MB
Notification: Performance of postOpt setEvaluationStage (simulation): time 0.002734/1.032, allocations: 1.101 MB / 0.8945 GB, free: 12.5 MB / 490.7 MB
Notification: Performance of sorting global known variables: time 0.001723/1.034, allocations: 0.8188 MB / 0.8953 GB, free: 11.68 MB / 490.7 MB
Notification: Performance of Backend: time 6.21e-07/1.034, allocations: 0 / 0.8953 GB, free: 11.68 MB / 490.7 MB
Notification: Performance of simCode: created initialization part: time 0.01442/1.049, allocations: 2.991 MB / 0.8982 GB, free: 8.703 MB / 490.7 MB
Notification: Performance of SimCode: time 0.01431/1.063, allocations: 5.082 MB / 0.9031 GB, free: 3.57 MB / 490.7 MB
Notification: Performance of Templates: time 0.4537/1.517, allocations: 60.92 MB / 0.9626 GB, free: 138.5 MB / 490.7 MB