Running: ./testmodel.py --libraries=/home/hudson/saved_omc/libraries/.openmodelica/libraries/ --ompython_omhome=/usr ModelicaTest_4.0.0_ModelicaTest.Fluid.TestComponents.Valves.TestValveVaporizing.conf.json
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)
loadFile("/home/hudson/saved_omc/libraries/.openmodelica/libraries/ModelicaTest 4.0.0+maint.om/package.mo", uses=false)
Using package ModelicaTest with version 4.0.0 (/home/hudson/saved_omc/libraries/.openmodelica/libraries/ModelicaTest 4.0.0+maint.om/package.mo)
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)
Running command: "" <> buildModelFMU(ModelicaTest.Fluid.TestComponents.Valves.TestValveVaporizing,fileNamePrefix="ModelicaTest_4_0_0_ModelicaTest_Fluid_TestComponents_Valves_TestValveVaporizing",fmuType="me",version="2.0",platforms={"static"})
"" <> buildModelFMU(ModelicaTest.Fluid.TestComponents.Valves.TestValveVaporizing,fileNamePrefix="ModelicaTest_4_0_0_ModelicaTest_Fluid_TestComponents_Valves_TestValveVaporizing",fmuType="me",version="2.0",platforms={"static"})
Notification: Performance of loadFile(/home/hudson/saved_omc/libraries/.openmodelica/libraries/Complex 4.0.0+maint.om/package.mo): time 0.001752/0.001752, allocations: 173.7 kB / 8.74 MB, free: 348 kB / 5.871 MB
Notification: Performance of loadFile(/home/hudson/saved_omc/libraries/.openmodelica/libraries/Modelica 4.0.0+maint.om/package.mo): time 1.489/1.489, allocations: 221.5 MB / 230.7 MB, free: 7.566 MB / 186.7 MB
Notification: Performance of loadFile(/home/hudson/saved_omc/libraries/.openmodelica/libraries/ModelicaServices 4.0.0+maint.om/package.mo): time 0.001015/0.001016, allocations: 96.66 kB / 281.6 MB, free: 5.32 MB / 234.7 MB
Notification: Performance of loadFile(/home/hudson/saved_omc/libraries/.openmodelica/libraries/ModelicaTest 4.0.0+maint.om/package.mo): time 0.2145/0.2145, allocations: 44.15 MB / 376.5 MB, free: 3.047 MB / 266.7 MB
Notification: Performance of FrontEnd - loaded program: time 1.749e-05/1.749e-05, allocations: 4.219 kB / 444.7 MB, free: 15.14 MB / 282.7 MB
Notification: Performance of FrontEnd - Absyn->SCode: time 0.1429/0.1429, allocations: 61.92 MB / 0.4948 GB, free: 1.156 MB / 330.7 MB
Notification: Performance of FrontEnd - scodeFlatten: time 7.952/8.095, allocations: 2.805 GB / 3.3 GB, free: 92.14 MB / 0.5105 GB
Notification: Performance of FrontEnd - mkProgramGraph: time 0.0002666/8.095, allocations: 87.5 kB / 3.3 GB, free: 92.1 MB / 0.5105 GB
Notification: Performance of FrontEnd - DAE generated: time 0.924/9.019, allocations: 236.5 MB / 3.531 GB, free: 87.38 MB / 0.5261 GB
Notification: Performance of FrontEnd: time 1.623e-06/9.019, allocations: 0 / 3.531 GB, free: 87.38 MB / 0.5261 GB
Notification: Performance of Transformations before backend: time 2.933e-05/9.02, allocations: 8 kB / 3.531 GB, free: 87.37 MB / 0.5261 GB
Notification: Model statistics after passing the front-end and creating the data structures used by the back-end:
 * Number of equations: 84
 * Number of variables: 84
Notification: Performance of Generate backend data structure: time 0.005616/9.025, allocations: 1.316 MB / 3.532 GB, free: 86.02 MB / 0.5261 GB
Notification: Performance of prepare preOptimizeDAE: time 4.723e-05/9.025, allocations: 11.98 kB / 3.532 GB, free: 86.01 MB / 0.5261 GB
Notification: Performance of preOpt normalInlineFunction (simulation): time 0.001895/9.027, allocations: 259.2 kB / 3.532 GB, free: 85.76 MB / 0.5261 GB
Notification: Performance of preOpt evaluateParameters (simulation): time 0.0006307/9.028, allocations: 412.1 kB / 3.533 GB, free: 85.32 MB / 0.5261 GB
Notification: Performance of preOpt simplifyIfEquations (simulation): time 3.349e-05/9.028, allocations: 12 kB / 3.533 GB, free: 85.3 MB / 0.5261 GB
Notification: Performance of preOpt expandDerOperator (simulation): time 4.447e-05/9.028, allocations: 22.81 kB / 3.533 GB, free: 85.29 MB / 0.5261 GB
Notification: Performance of preOpt removeEqualFunctionCalls (simulation): time 0.0005238/9.028, allocations: 361.3 kB / 3.533 GB, free: 84.93 MB / 0.5261 GB
Notification: Performance of preOpt clockPartitioning (simulation): time 0.0005523/9.029, allocations: 416.8 kB / 3.533 GB, free: 84.48 MB / 0.5261 GB
Notification: Performance of preOpt findStateOrder (simulation): time 1.319e-05/9.029, allocations: 4 kB / 3.533 GB, free: 84.48 MB / 0.5261 GB
Notification: Performance of preOpt replaceEdgeChange (simulation): time 4.062e-05/9.029, allocations: 0 / 3.533 GB, free: 84.48 MB / 0.5261 GB
Notification: Performance of preOpt inlineArrayEqn (simulation): time 1.088e-05/9.029, allocations: 8 kB / 3.533 GB, free: 84.47 MB / 0.5261 GB
Warning: The model contains alias variables with conflicting start and/or 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.01758/9.047, allocations: 10.37 MB / 3.544 GB, free: 73.09 MB / 0.5261 GB
Notification: Performance of preOpt comSubExp (simulation): time 0.0005292/9.047, allocations: 254.8 kB / 3.544 GB, free: 72.84 MB / 0.5261 GB
Notification: Performance of preOpt resolveLoops (simulation): time 0.0001731/9.047, allocations: 128.8 kB / 3.544 GB, free: 72.71 MB / 0.5261 GB
Notification: Performance of preOpt evalFunc (simulation): time 0.04507/9.092, allocations: 24.28 MB / 3.568 GB, free: 45.53 MB / 0.5261 GB
Notification: Performance of preOpt encapsulateWhenConditions (simulation): time 3.821e-05/9.093, allocations: 42.5 kB / 3.568 GB, free: 45.48 MB / 0.5261 GB
Notification: Performance of pre-optimization done (n=26): time 2.515e-06/9.093, allocations: 0 / 3.568 GB, free: 45.48 MB / 0.5261 GB
Notification: Performance of matching and sorting (n=26): time 0.002105/9.095, allocations: 0.5631 MB / 3.568 GB, free: 44.91 MB / 0.5261 GB
Notification: Performance of inlineWhenForInitialization (initialization): time 5.009e-05/9.095, allocations: 110.8 kB / 3.568 GB, free: 44.78 MB / 0.5261 GB
Notification: Performance of selectInitializationVariablesDAE (initialization): time 0.0003347/9.095, allocations: 262.4 kB / 3.569 GB, free: 44.52 MB / 0.5261 GB
Notification: Performance of collectPreVariables (initialization): time 3.299e-05/9.095, allocations: 25.7 kB / 3.569 GB, free: 44.48 MB / 0.5261 GB
Notification: Performance of collectInitialEqns (initialization): time 0.0001273/9.095, allocations: 240 kB / 3.569 GB, free: 44.24 MB / 0.5261 GB
Notification: Performance of collectInitialBindings (initialization): time 6.258e-05/9.095, allocations: 86.75 kB / 3.569 GB, free: 44.16 MB / 0.5261 GB
Notification: Performance of simplifyInitialFunctions (initialization): time 1.96e-05/9.095, allocations: 0 / 3.569 GB, free: 44.16 MB / 0.5261 GB
Notification: Performance of setup shared object (initialization): time 8.563e-05/9.095, allocations: 342.9 kB / 3.569 GB, free: 43.81 MB / 0.5261 GB
Notification: Performance of preBalanceInitialSystem (initialization): time 0.0001376/9.096, allocations: 96.64 kB / 3.569 GB, free: 43.71 MB / 0.5261 GB
Notification: Performance of partitionIndependentBlocks (initialization): time 0.0001801/9.096, allocations: 217.7 kB / 3.57 GB, free: 43.46 MB / 0.5261 GB
Notification: Performance of analyzeInitialSystem (initialization): time 0.0008099/9.097, allocations: 201 kB / 3.57 GB, free: 43.26 MB / 0.5261 GB
Notification: Performance of solveInitialSystemEqSystem (initialization): time 4.007e-06/9.097, allocations: 0 / 3.57 GB, free: 43.26 MB / 0.5261 GB
Notification: Performance of matching and sorting (n=39) (initialization): time 0.001133/9.098, allocations: 437.2 kB / 3.57 GB, free: 42.83 MB / 0.5261 GB
Notification: Performance of prepare postOptimizeDAE: time 0.0002576/9.098, allocations: 1.044 MB / 3.571 GB, free: 41.7 MB / 0.5261 GB
Notification: Performance of postOpt simplifyComplexFunction (initialization): time 9.988e-06/9.098, allocations: 4 kB / 3.571 GB, free: 41.7 MB / 0.5261 GB
Notification: Performance of postOpt tearingSystem (initialization): time 2.265e-05/9.098, allocations: 4 kB / 3.571 GB, free: 41.7 MB / 0.5261 GB
Notification: Performance of postOpt solveSimpleEquations (initialization): time 0.000472/9.099, allocations: 111.9 kB / 3.571 GB, free: 41.59 MB / 0.5261 GB
Notification: Performance of postOpt calculateStrongComponentJacobians (initialization): time 9.017e-06/9.099, allocations: 7.984 kB / 3.571 GB, free: 41.58 MB / 0.5261 GB
Notification: Performance of postOpt simplifyAllExpressions (initialization): time 0.0005271/9.099, allocations: 79.64 kB / 3.571 GB, free: 41.5 MB / 0.5261 GB
Notification: Performance of postOpt collapseArrayExpressions (initialization): time 3.953e-05/9.099, allocations: 19.98 kB / 3.571 GB, free: 41.48 MB / 0.5261 GB
Notification: Performance of prepare postOptimizeDAE: time 8.746e-06/9.099, allocations: 7.938 kB / 3.571 GB, free: 41.47 MB / 0.5261 GB
Notification: Performance of postOpt replaceHomotopyWithSimplified (initialization): time 0.0008592/9.1, allocations: 331.6 kB / 3.572 GB, free: 41.15 MB / 0.5261 GB
Notification: Performance of postOpt simplifyComplexFunction (initialization): time 3.166e-06/9.1, allocations: 0 / 3.572 GB, free: 41.15 MB / 0.5261 GB
Notification: Performance of postOpt tearingSystem (initialization): time 7.314e-06/9.1, allocations: 11.95 kB / 3.572 GB, free: 41.14 MB / 0.5261 GB
Notification: Performance of postOpt solveSimpleEquations (initialization): time 0.0004294/9.1, allocations: 108.2 kB / 3.572 GB, free: 41.03 MB / 0.5261 GB
Notification: Performance of postOpt calculateStrongComponentJacobians (initialization): time 5.69e-06/9.1, allocations: 11.94 kB / 3.572 GB, free: 41.02 MB / 0.5261 GB
Notification: Performance of postOpt simplifyAllExpressions (initialization): time 0.0004208/9.101, allocations: 67.72 kB / 3.572 GB, free: 40.95 MB / 0.5261 GB
Notification: Performance of postOpt collapseArrayExpressions (initialization): time 2.65e-05/9.101, allocations: 16 kB / 3.572 GB, free: 40.94 MB / 0.5261 GB
Notification: Model statistics after passing the back-end for initialization:
 * Number of independent subsystems: 12
 * Number of states: 0 ()
 * Number of discrete variables: 4 (SourceP1.medium.phase,SinkP1.medium.phase,V1.state_b.phase,V1.state_a.phase)
 * Number of discrete states: 0 ()
 * Top-level inputs: 0
Notification: Strong component statistics for initialization (39):
 * Single equations (assignments): 39
 * 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.0001297/9.101, allocations: 116.9 kB / 3.572 GB, free: 40.82 MB / 0.5261 GB
Notification: Performance of postOpt createAliasVarsForOutputStates (simulation): time 0.0009694/9.102, allocations: 349 kB / 3.572 GB, free: 40.47 MB / 0.5261 GB
Notification: Performance of postOpt lateInlineFunction (simulation): time 5.936e-05/9.102, allocations: 35.58 kB / 3.572 GB, free: 40.43 MB / 0.5261 GB
Notification: Performance of postOpt wrapFunctionCalls (simulation): time 0.00185/9.104, allocations: 1.69 MB / 3.574 GB, free: 38.73 MB / 0.5261 GB
Notification: Performance of postOpt inlineArrayEqn (simulation): time 1.93e-05/9.104, allocations: 19.95 kB / 3.574 GB, free: 38.71 MB / 0.5261 GB
Notification: Performance of postOpt constantLinearSystem (simulation): time 6.292e-06/9.104, allocations: 4 kB / 3.574 GB, free: 38.71 MB / 0.5261 GB
Notification: Performance of postOpt simplifysemiLinear (simulation): time 5.27e-06/9.104, allocations: 0 / 3.574 GB, free: 38.71 MB / 0.5261 GB
Notification: Performance of postOpt removeSimpleEquations (simulation): time 0.0007978/9.105, allocations: 0.8773 MB / 3.575 GB, free: 37.8 MB / 0.5261 GB
Notification: Performance of postOpt simplifyComplexFunction (simulation): time 3.998e-06/9.105, allocations: 4 kB / 3.575 GB, free: 37.79 MB / 0.5261 GB
Notification: Performance of postOpt solveSimpleEquations (simulation): time 0.0004063/9.105, allocations: 99.86 kB / 3.575 GB, free: 37.7 MB / 0.5261 GB
Notification: Performance of postOpt tearingSystem (simulation): time 4.81e-06/9.105, allocations: 0 / 3.575 GB, free: 37.7 MB / 0.5261 GB
Notification: Performance of postOpt inputDerivativesUsed (simulation): time 2.214e-05/9.105, allocations: 7.953 kB / 3.575 GB, free: 37.69 MB / 0.5261 GB
Notification: Performance of postOpt calculateStrongComponentJacobians (simulation): time 3.457e-06/9.105, allocations: 4 kB / 3.575 GB, free: 37.68 MB / 0.5261 GB
Notification: Performance of postOpt calculateStateSetsJacobians (simulation): time 3.727e-06/9.105, allocations: 3.984 kB / 3.575 GB, free: 37.68 MB / 0.5261 GB
Notification: Performance of postOpt symbolicJacobian (simulation): time 0.001141/9.106, allocations: 0.9633 MB / 3.576 GB, free: 36.7 MB / 0.5261 GB
Notification: Performance of postOpt removeConstants (simulation): time 0.0002283/9.107, allocations: 255.5 kB / 3.576 GB, free: 36.43 MB / 0.5261 GB
Notification: Performance of postOpt simplifyTimeIndepFuncCalls (simulation): time 6.723e-05/9.107, allocations: 3.984 kB / 3.576 GB, free: 36.43 MB / 0.5261 GB
Notification: Performance of postOpt simplifyAllExpressions (simulation): time 0.0004117/9.107, allocations: 55.81 kB / 3.576 GB, free: 36.38 MB / 0.5261 GB
Notification: Performance of postOpt findZeroCrossings (simulation): time 8.454e-05/9.107, allocations: 31.95 kB / 3.576 GB, free: 36.34 MB / 0.5261 GB
Notification: Performance of postOpt collapseArrayExpressions (simulation): time 2.502e-05/9.107, allocations: 15.98 kB / 3.576 GB, free: 36.33 MB / 0.5261 GB
Notification: Performance of sorting global known variables: time 0.00028/9.108, allocations: 311 kB / 3.577 GB, free: 36.02 MB / 0.5261 GB
Notification: Performance of sort global known variables: time 1.6e-07/9.108, allocations: 0 / 3.577 GB, free: 36.02 MB / 0.5261 GB
Notification: Performance of remove unused functions: time 0.005336/9.113, allocations: 1.143 MB / 3.578 GB, free: 34.88 MB / 0.5261 GB
Notification: Model statistics after passing the back-end for simulation:
 * Number of independent subsystems: 1
 * Number of states: 0 ()
 * Number of discrete variables: 16 ($cse1.phase,$cse1.region,$cse2.phase,$cse2.region,$cse3.region3boundary,$cse4.region3boundary,$cse5.phase,$cse5.region,$cse9.phase,$cse9.region,$cse10.phase,$cse10.region,$cse12.phase,$cse12.region,SourceP1.medium.phase,SinkP1.medium.phase)
 * Number of discrete states: 0 ()
 * Top-level inputs: 0
Notification: Strong component statistics for simulation (36):
 * Single equations (assignments): 28
 * Array equations: 0
 * Algorithm blocks: 0
 * Record equations: 8
 * 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.009713/9.123, allocations: 2.904 MB / 3.581 GB, free: 32.05 MB / 0.5261 GB
Notification: Performance of simCode: created initialization part: time 0.00109/9.124, allocations: 0.649 MB / 3.581 GB, free: 31.41 MB / 0.5261 GB
Notification: Performance of simCode: created event and clocks part: time 4.659e-06/9.124, allocations: 3.938 kB / 3.581 GB, free: 31.4 MB / 0.5261 GB
Notification: Performance of simCode: created simulation system equations: time 0.0003748/9.124, allocations: 433.2 kB / 3.582 GB, free: 30.98 MB / 0.5261 GB
Notification: Performance of simCode: created of all other equations (e.g. parameter, nominal, assert, etc): time 0.001128/9.125, allocations: 190.1 kB / 3.582 GB, free: 30.8 MB / 0.5261 GB
Notification: Performance of simCode: created linear, non-linear and system jacobian parts: time 0.005334/9.131, allocations: 1.569 MB / 3.583 GB, free: 29.19 MB / 0.5261 GB
Notification: Performance of simCode: some other stuff during SimCode phase: time 0.00036/9.131, allocations: 0.9839 MB / 3.584 GB, free: 28.18 MB / 0.5261 GB
Notification: Performance of simCode: alias equations: time 0.0008148/9.132, allocations: 0.5636 MB / 3.585 GB, free: 27.62 MB / 0.5261 GB
Notification: Performance of simCode: all other stuff during SimCode phase: time 0.0002615/9.132, allocations: 259.3 kB / 3.585 GB, free: 27.36 MB / 0.5261 GB
Notification: Performance of SimCode: time 8.32e-07/9.132, allocations: 0 / 3.585 GB, free: 27.36 MB / 0.5261 GB
Notification: Performance of buildModelFMU: Generate the FMI files: time 0.4872/9.619, allocations: 37.19 MB / 3.621 GB, free: 98.01 MB / 0.5261 GB
Notification: Performance of buildModelFMU: configured platform static using cached values: time 0.0002053/9.62, allocations: 191.7 kB / 3.622 GB, free: 97.82 MB / 0.5261 GB
Notification: Performance of buildModelFMU: Generate platform static: time 3.288/12.91, allocations: 5.344 kB / 3.622 GB, free: 97.82 MB / 0.5261 GB
(rm -f ModelicaTest_4.0.0_ModelicaTest.Fluid.TestComponents.Valves.TestValveVaporizing.pipe ; mkfifo ModelicaTest_4.0.0_ModelicaTest.Fluid.TestComponents.Valves.TestValveVaporizing.pipe ; head -c 1048576 < ModelicaTest_4.0.0_ModelicaTest.Fluid.TestComponents.Valves.TestValveVaporizing.pipe >> ../files/ModelicaTest_4.0.0_ModelicaTest.Fluid.TestComponents.Valves.TestValveVaporizing.sim & /home/hudson/saved_omc/OMSimulator/install/linux/bin/OMSimulator -r=ModelicaTest_4.0.0_ModelicaTest.Fluid.TestComponents.Valves.TestValveVaporizing_res.mat --tempDir=temp_ModelicaTest_4_0_0_ModelicaTest_Fluid_TestComponents_Valves_TestValveVaporizing_fmu --startTime=0 --stopTime=1.01 --timeout=50 --tolerance=1e-06 ModelicaTest_4_0_0_ModelicaTest_Fluid_TestComponents_Valves_TestValveVaporizing.fmu > ModelicaTest_4.0.0_ModelicaTest.Fluid.TestComponents.Valves.TestValveVaporizing.pipe 2>&1)
TODO: How the !@#!# did the simulation report success but simulation result ModelicaTest_4.0.0_ModelicaTest.Fluid.TestComponents.Valves.TestValveVaporizing_res.mat does not exist to compare? outputFormat=mat