Running: ./testmodel.py --libraries=/var/lib/hudson/saved_omc/libraries/.openmodelica/libraries/ --ompython_omhome=/usr ModelicaTest_3.2.2_ModelicaTest.Media.TestAllProperties.IncompleteMedia.WaterIF97_ph.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.Media.TestAllProperties.IncompleteMedia.WaterIF97_ph,tolerance=1e-06,outputFormat="mat",numberOfIntervals=5000,variableFilter="time|eps_h_is|eps|eta|lambda|Pr|p|T|d|h|u|s|g|f|cp|cp2|cv|cv2|h_is|a|beta|beta2|kappa|kappa2|MM|h2|d2|err_T|err_d|err_u|s_is|err_h_is",fileNamePrefix="ModelicaTest_3.2.2_ModelicaTest.Media.TestAllProperties.IncompleteMedia.WaterIF97_ph")
Notification: Performance of loadFile(/var/lib/hudson/saved_omc/libraries/.openmodelica/libraries/Complex 3.2.2+maint.om/package.mo): time 0.004648/0.004647, allocations: 369.9 kB / 15.96 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.252/4.252, allocations: 388.9 MB / 405.6 MB, free: 10.24 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.00361/0.00361, allocations: 237.8 kB / 451 MB, free: 145.1 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.5748/0.5748, allocations: 80.02 MB / 0.5627 GB, free: 19.84 MB / 346.7 MB
Notification: Performance of FrontEnd - loaded program: time 0.0004647/0.000465, allocations: 12 kB / 0.6265 GB, free: 96.55 MB / 346.7 MB
Notification: Performance of FrontEnd - Absyn->SCode: time 0.1015/0.102, allocations: 54.87 MB / 0.6801 GB, free: 41.66 MB / 346.7 MB
Notification: Performance of NFInst.instantiate(ModelicaTest.Media.TestAllProperties.IncompleteMedia.WaterIF97_ph): time 0.01735/0.1194, allocations: 12.77 MB / 0.6926 GB, free: 28.84 MB / 346.7 MB
Notification: Performance of NFInst.instExpressions: time 0.03477/0.1543, allocations: 24.59 MB / 0.7166 GB, free: 4.199 MB / 346.7 MB
Notification: Performance of NFInst.updateImplicitVariability: time 0.0003133/0.1546, allocations: 4 kB / 0.7166 GB, free: 4.195 MB / 346.7 MB
Notification: Performance of NFTyping.typeComponents: time 0.0003886/0.155, allocations: 71.58 kB / 0.7167 GB, free: 4.125 MB / 346.7 MB
Notification: Performance of NFTyping.typeBindings: time 0.3597/0.5147, allocations: 6.553 MB / 0.7231 GB, free: 14.69 MB / 346.7 MB
Notification: Performance of NFTyping.typeClassSections: time 0.001981/0.5168, allocations: 296.5 kB / 0.7233 GB, free: 14.69 MB / 346.7 MB
Notification: Performance of NFFlatten.flatten: time 0.04395/0.5607, allocations: 3.203 MB / 0.7265 GB, free: 14.65 MB / 346.7 MB
Notification: Performance of NFFlatten.resolveConnections: time 0.000117/0.5609, allocations: 19.41 kB / 0.7265 GB, free: 14.64 MB / 346.7 MB
Notification: Performance of NFEvalConstants.evaluate: time 0.0008851/0.5618, allocations: 246.9 kB / 0.7267 GB, free: 14.64 MB / 346.7 MB
Notification: Performance of NFSimplifyModel.simplify: time 0.02014/0.582, allocations: 5.672 MB / 0.7323 GB, free: 14.56 MB / 346.7 MB
Notification: Performance of NFPackage.collectConstants: time 0.0001249/0.5822, allocations: 9.281 kB / 0.7323 GB, free: 14.56 MB / 346.7 MB
Notification: Performance of NFFlatten.collectFunctions: time 0.04703/0.6292, allocations: 10.36 MB / 0.7424 GB, free: 13.95 MB / 346.7 MB
Notification: Performance of NFScalarize.scalarize: time 0.0001372/0.6295, allocations: 45.23 kB / 0.7424 GB, free: 13.94 MB / 346.7 MB
Notification: Performance of NFVerifyModel.verify: time 0.0002156/0.6297, allocations: 76.14 kB / 0.7425 GB, free: 13.91 MB / 346.7 MB
Notification: Performance of NFConvertDAE.convert: time 0.01157/0.6413, allocations: 4.215 MB / 0.7466 GB, free: 10.94 MB / 346.7 MB
Notification: Performance of FrontEnd - DAE generated: time 8.005e-06/0.6413, allocations: 5.859 kB / 0.7466 GB, free: 10.93 MB / 346.7 MB
Notification: Performance of FrontEnd: time 2.264e-06/0.6414, allocations: 0 / 0.7466 GB, free: 10.93 MB / 346.7 MB
Notification: Performance of Transformations before backend: time 1.657e-05/0.6414, allocations: 0 / 0.7466 GB, free: 10.93 MB / 346.7 MB
Notification: Model statistics after passing the front-end and creating the data structures used by the back-end:
 * Number of equations: 77
 * Number of variables: 77
Notification: Performance of Generate backend data structure: time 0.006402/0.6478, allocations: 1.493 MB / 0.7481 GB, free: 9.469 MB / 346.7 MB
Notification: Performance of prepare preOptimizeDAE: time 5.26e-05/0.6479, allocations: 8.031 kB / 0.7481 GB, free: 9.461 MB / 346.7 MB
Notification: Performance of preOpt normalInlineFunction (simulation): time 0.002361/0.6502, allocations: 234.5 kB / 0.7483 GB, free: 9.254 MB / 346.7 MB
Notification: Performance of preOpt evaluateParameters (simulation): time 0.0004491/0.6507, allocations: 274 kB / 0.7486 GB, free: 8.984 MB / 346.7 MB
Notification: Performance of preOpt simplifyIfEquations (simulation): time 4.749e-05/0.6508, allocations: 22.59 kB / 0.7486 GB, free: 8.973 MB / 346.7 MB
Notification: Performance of preOpt expandDerOperator (simulation): time 9.117e-05/0.6509, allocations: 29.75 kB / 0.7486 GB, free: 8.953 MB / 346.7 MB
Notification: Performance of preOpt clockPartitioning (simulation): time 0.00334/0.6543, allocations: 0.8271 MB / 0.7494 GB, free: 8.273 MB / 346.7 MB
Notification: Performance of preOpt findStateOrder (simulation): time 2.172e-05/0.6543, allocations: 8 kB / 0.7494 GB, free: 8.266 MB / 346.7 MB
Notification: Performance of preOpt replaceEdgeChange (simulation): time 6.214e-05/0.6544, allocations: 13.88 kB / 0.7494 GB, free: 8.262 MB / 346.7 MB
Notification: Performance of preOpt inlineArrayEqn (simulation): time 1.234e-05/0.6544, allocations: 8 kB / 0.7495 GB, free: 8.254 MB / 346.7 MB
Notification: Performance of preOpt removeEqualRHS (simulation): time 0.00539/0.6598, allocations: 0.9445 MB / 0.7504 GB, free: 7.516 MB / 346.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.006656/0.6665, allocations: 2.58 MB / 0.7529 GB, free: 4.969 MB / 346.7 MB
Notification: Performance of preOpt comSubExp (simulation): time 0.003605/0.6702, allocations: 372.9 kB / 0.7533 GB, free: 4.664 MB / 346.7 MB
Notification: Performance of preOpt resolveLoops (simulation): time 0.0002836/0.6705, allocations: 80.78 kB / 0.7533 GB, free: 4.605 MB / 346.7 MB
Notification: Performance of preOpt evalFunc (simulation): time 1.431/2.101, allocations: 227.1 MB / 0.9751 GB, free: 140.8 MB / 0.4949 GB
Notification: Performance of preOpt encapsulateWhenConditions (simulation): time 0.00198/2.103, allocations: 475.4 kB / 0.9755 GB, free: 140.3 MB / 0.4949 GB
Notification: Performance of pre-optimization done (n=32): time 4.087e-06/2.103, allocations: 0 / 0.9755 GB, free: 140.3 MB / 0.4949 GB
Notification: Performance of matching and sorting (n=32): time 0.004392/2.108, allocations: 0.771 MB / 0.9763 GB, free: 139.5 MB / 0.4949 GB
Notification: Performance of inlineWhenForInitialization (initialization): time 9.144e-05/2.108, allocations: 375.8 kB / 0.9767 GB, free: 139.1 MB / 0.4949 GB
Notification: Performance of selectInitializationVariablesDAE (initialization): time 0.0002076/2.108, allocations: 179.9 kB / 0.9768 GB, free: 138.9 MB / 0.4949 GB
Notification: Performance of collectPreVariables (initialization): time 5.803e-05/2.108, allocations: 32.22 kB / 0.9769 GB, free: 138.9 MB / 0.4949 GB
Notification: Performance of collectInitialEqns (initialization): time 0.0001036/2.108, allocations: 188.6 kB / 0.977 GB, free: 138.7 MB / 0.4949 GB
Notification: Performance of collectInitialBindings (initialization): time 0.0001182/2.108, allocations: 110.5 kB / 0.9771 GB, free: 138.6 MB / 0.4949 GB
Notification: Performance of simplifyInitialFunctions (initialization): time 4.324e-05/2.108, allocations: 12 kB / 0.9772 GB, free: 138.6 MB / 0.4949 GB
Notification: Performance of setup shared object (initialization): time 7.508e-05/2.109, allocations: 334.8 kB / 0.9775 GB, free: 138.2 MB / 0.4949 GB
Notification: Performance of preBalanceInitialSystem (initialization): time 0.0003432/2.109, allocations: 77.06 kB / 0.9775 GB, free: 138.1 MB / 0.4949 GB
Notification: Performance of partitionIndependentBlocks (initialization): time 0.0004736/2.109, allocations: 343.2 kB / 0.9779 GB, free: 137.7 MB / 0.4949 GB
Notification: Performance of analyzeInitialSystem (initialization): time 0.0004265/2.11, allocations: 133.8 kB / 0.978 GB, free: 137.6 MB / 0.4949 GB
Notification: Performance of solveInitialSystemEqSystem (initialization): time 9.037e-06/2.11, allocations: 4 kB / 0.978 GB, free: 137.6 MB / 0.4949 GB
Notification: Performance of matching and sorting (n=58) (initialization): time 0.001347/2.111, allocations: 477.4 kB / 0.9785 GB, free: 137.1 MB / 0.4949 GB
Notification: Performance of prepare postOptimizeDAE: time 3.109e-05/2.111, allocations: 8 kB / 0.9785 GB, free: 137.1 MB / 0.4949 GB
Notification: Performance of postOpt simplifyComplexFunction (initialization): time 1.72e-05/2.111, allocations: 8 kB / 0.9785 GB, free: 137.1 MB / 0.4949 GB
Notification: Performance of postOpt tearingSystem (initialization): time 3.588e-05/2.111, allocations: 16 kB / 0.9785 GB, free: 137.1 MB / 0.4949 GB
Notification: Performance of postOpt solveSimpleEquations (initialization): time 0.0007929/2.112, allocations: 139.8 kB / 0.9786 GB, free: 136.9 MB / 0.4949 GB
Notification: Performance of postOpt calculateStrongComponentJacobians (initialization): time 2.118e-05/2.112, allocations: 20.25 kB / 0.9786 GB, free: 136.9 MB / 0.4949 GB
Notification: Performance of postOpt simplifyAllExpressions (initialization): time 0.000535/2.113, allocations: 49.89 kB / 0.9787 GB, free: 136.9 MB / 0.4949 GB
Notification: Performance of postOpt collapseArrayExpressions (initialization): time 8.553e-05/2.113, allocations: 43.97 kB / 0.9787 GB, free: 136.8 MB / 0.4949 GB
Notification: Model statistics after passing the back-end for initialization:
 * Number of independent subsystems: 41
 * Number of states: 0 ()
 * Number of discrete variables: 8 ($whenCondition1,medium.phase,state.phase,state_h_is.phase,state5.phase,state4.phase,state3.phase,state2.phase)
 * Number of discrete states: 0 ()
 * Number of clocked states: 0 ()
 * Top-level inputs: 0
Notification: Strong component statistics for initialization (58):
 * Single equations (assignments): 58
 * 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.0002493/2.113, allocations: 169.7 kB / 0.9789 GB, free: 136.6 MB / 0.4949 GB
Notification: Performance of postOpt lateInlineFunction (simulation): time 0.0001006/2.113, allocations: 31.66 kB / 0.9789 GB, free: 136.6 MB / 0.4949 GB
Notification: Performance of postOpt wrapFunctionCalls (simulation): time 0.003934/2.117, allocations: 2.66 MB / 0.9815 GB, free: 133.9 MB / 0.4949 GB
Notification: Performance of postOpt simplifysemiLinear (simulation): time 2.081e-05/2.117, allocations: 7.984 kB / 0.9815 GB, free: 133.9 MB / 0.4949 GB
Notification: Performance of postOpt simplifyComplexFunction (simulation): time 1.093e-05/2.117, allocations: 4 kB / 0.9815 GB, free: 133.9 MB / 0.4949 GB
Notification: Performance of postOpt removeConstants (simulation): time 0.0005268/2.118, allocations: 377.6 kB / 0.9819 GB, free: 133.6 MB / 0.4949 GB
Notification: Performance of postOpt simplifyTimeIndepFuncCalls (simulation): time 0.0002171/2.118, allocations: 11.98 kB / 0.9819 GB, free: 133.5 MB / 0.4949 GB
Notification: Performance of postOpt simplifyAllExpressions (simulation): time 0.0007738/2.119, allocations: 44.23 kB / 0.9819 GB, free: 133.5 MB / 0.4949 GB
Notification: Performance of postOpt findZeroCrossings (simulation): time 8.484e-05/2.119, allocations: 27.92 kB / 0.982 GB, free: 133.5 MB / 0.4949 GB
Notification: Performance of postOpt createDAEmodeBDAE (simulation): time 0.001436/2.12, allocations: 1.549 MB / 0.9835 GB, free: 131.9 MB / 0.4949 GB
Notification: Performance of postOpt detectDAEmodeSparsePattern (simulation): time 0.00146/2.122, allocations: 1.66 MB / 0.9851 GB, free: 130.2 MB / 0.4949 GB
Notification: Performance of postOpt setEvaluationStage (simulation): time 0.0004589/2.122, allocations: 248.8 kB / 0.9853 GB, free: 130 MB / 0.4949 GB
Notification: Performance of sorting global known variables: time 0.0008991/2.123, allocations: 0.4995 MB / 0.9858 GB, free: 129.5 MB / 0.4949 GB
Notification: Performance of Backend: time 1.953e-06/2.123, allocations: 0 / 0.9858 GB, free: 129.5 MB / 0.4949 GB
Notification: Performance of simCode: created initialization part: time 0.01594/2.139, allocations: 2.467 MB / 0.9882 GB, free: 127.4 MB / 0.4949 GB
Notification: Performance of SimCode: time 0.002681/2.142, allocations: 2.034 MB / 0.9902 GB, free: 125.3 MB / 0.4949 GB
Notification: Performance of Templates: time 0.1449/2.287, allocations: 65.27 MB / 1.054 GB, free: 60.05 MB / 0.4949 GB