Running: ./testmodel.py --libraries=/home/hudson/saved_omc/libraries/.openmodelica/libraries/ --ompython_omhome=/usr Modelica_4.0.0_Modelica.Fluid.Examples.InverseParameterization.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)
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(Modelica.Fluid.Examples.InverseParameterization,fileNamePrefix="Modelica_4_0_0_Modelica_Fluid_Examples_InverseParameterization",fmuType="me",version="2.0",platforms={"static"})
"" <> buildModelFMU(Modelica.Fluid.Examples.InverseParameterization,fileNamePrefix="Modelica_4_0_0_Modelica_Fluid_Examples_InverseParameterization",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.001399/0.0014, allocations: 176.4 kB / 8.346 MB, free: 0.7266 MB / 5.871 MB
Notification: Performance of loadFile(/home/hudson/saved_omc/libraries/.openmodelica/libraries/Modelica 4.0.0+maint.om/package.mo): time 1.373/1.373, allocations: 221.5 MB / 230.3 MB, free: 7.516 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.001055/0.001055, allocations: 96.45 kB / 281.2 MB, free: 5.27 MB / 234.7 MB
Notification: Performance of FrontEnd - loaded program: time 2.062e-05/2.064e-05, allocations: 4 kB / 337.1 MB, free: 9.934 MB / 234.7 MB
Notification: Performance of FrontEnd - Absyn->SCode: time 0.1181/0.1182, allocations: 50.42 MB / 387.5 MB, free: 7.477 MB / 282.7 MB
Notification: Performance of FrontEnd - scodeFlatten: time 7.405/7.523, allocations: 2.813 GB / 3.191 GB, free: 95 MB / 442.7 MB
Notification: Performance of FrontEnd - mkProgramGraph: time 0.0003422/7.524, allocations: 79.73 kB / 3.191 GB, free: 94.93 MB / 442.7 MB
[/home/hudson/saved_omc/libraries/.openmodelica/libraries/Modelica 4.0.0+maint.om/Fluid/Interfaces.mo:714:9-719:39:writable] Notification: From here:
[/home/hudson/saved_omc/libraries/.openmodelica/libraries/Modelica 4.0.0+maint.om/Fluid/Interfaces.mo:306:3-308:69:writable] Warning: Inherited elements are not identical: bug: https://trac.modelica.org/Modelica/ticket/627
        first:  Medium.MassFlowRate m_flow(min = if allowFlowReversal then -Modelica.Constants.inf else 0, start = m_flow_start, stateSelect = if momentumDynamics == Modelica.Fluid.Types.Dynamics.SteadyState then StateSelect.default else StateSelect.prefer) "Mass flow rates between states"
        second: Medium.MassFlowRate m_flow(min = if allowFlowReversal then -Modelica.Constants.inf else 0, start = m_flow_start) "Mass flow rate in design flow direction"
Continue ....
Notification: Performance of FrontEnd - DAE generated: time 3.169/10.69, allocations: 0.7495 GB / 3.941 GB, free: 13.05 MB / 458.7 MB
Notification: Performance of FrontEnd: time 6.643e-06/10.69, allocations: 4 kB / 3.941 GB, free: 13.05 MB / 458.7 MB
Notification: Performance of Transformations before backend: time 0.0002852/10.69, allocations: 32 kB / 3.941 GB, free: 13.02 MB / 458.7 MB
Notification: Model statistics after passing the front-end and creating the data structures used by the back-end:
 * Number of equations: 287
 * Number of variables: 287
Notification: Performance of Generate backend data structure: time 0.01669/10.71, allocations: 2.723 MB / 3.943 GB, free: 10.25 MB / 458.7 MB
Notification: Performance of prepare preOptimizeDAE: time 5.754e-05/10.71, allocations: 8.031 kB / 3.943 GB, free: 10.25 MB / 458.7 MB
Notification: Performance of preOpt normalInlineFunction (simulation): time 0.005472/10.72, allocations: 0.6002 MB / 3.944 GB, free: 9.645 MB / 458.7 MB
Notification: Performance of preOpt evaluateParameters (simulation): time 0.00345/10.72, allocations: 1.073 MB / 3.945 GB, free: 8.551 MB / 458.7 MB
Notification: Performance of preOpt simplifyIfEquations (simulation): time 0.0001848/10.72, allocations: 48 kB / 3.945 GB, free: 8.504 MB / 458.7 MB
Notification: Performance of preOpt expandDerOperator (simulation): time 0.0005579/10.72, allocations: 64 kB / 3.945 GB, free: 8.441 MB / 458.7 MB
Notification: Performance of preOpt removeEqualFunctionCalls (simulation): time 0.003665/10.72, allocations: 1.75 MB / 3.947 GB, free: 6.688 MB / 458.7 MB
Notification: Performance of preOpt clockPartitioning (simulation): time 0.003535/10.73, allocations: 1.549 MB / 3.948 GB, free: 5.008 MB / 458.7 MB
Notification: Performance of preOpt findStateOrder (simulation): time 3.98e-05/10.73, allocations: 3.938 kB / 3.948 GB, free: 5.004 MB / 458.7 MB
Notification: Performance of preOpt replaceEdgeChange (simulation): time 0.0002657/10.73, allocations: 8 kB / 3.948 GB, free: 4.996 MB / 458.7 MB
Notification: Performance of preOpt inlineArrayEqn (simulation): time 0.0001226/10.73, allocations: 86 kB / 3.948 GB, free: 4.91 MB / 458.7 MB
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.839/11.57, allocations: 167.3 MB / 4.112 GB, free: 24.48 MB / 0.5417 GB
Notification: Performance of preOpt comSubExp (simulation): time 0.003096/11.57, allocations: 1.111 MB / 4.113 GB, free: 24.44 MB / 0.5417 GB
Notification: Performance of preOpt resolveLoops (simulation): time 0.001113/11.57, allocations: 0.5726 MB / 4.113 GB, free: 24.43 MB / 0.5417 GB
Notification: Performance of preOpt evalFunc (simulation): time 0.03647/11.61, allocations: 16.92 MB / 4.13 GB, free: 13.45 MB / 0.5417 GB
Notification: Performance of preOpt encapsulateWhenConditions (simulation): time 7.258e-05/11.61, allocations: 41.91 kB / 4.13 GB, free: 13.4 MB / 0.5417 GB
Notification: Performance of preOpt simplifyInStream (simulation): time 0.001809/11.61, allocations: 179 kB / 4.13 GB, free: 13.39 MB / 0.5417 GB
Notification: Performance of pre-optimization done (n=91): time 1.338e-05/11.61, allocations: 0 / 4.13 GB, free: 13.39 MB / 0.5417 GB
Notification: Performance of matching and sorting (n=91): time 0.01109/11.62, allocations: 2.395 MB / 4.133 GB, free: 13.29 MB / 0.5417 GB
Notification: Performance of inlineWhenForInitialization (initialization): time 0.000163/11.62, allocations: 218.8 kB / 4.133 GB, free: 13.04 MB / 0.5417 GB
Notification: Performance of selectInitializationVariablesDAE (initialization): time 0.001951/11.62, allocations: 0.7436 MB / 4.133 GB, free: 12.89 MB / 0.5417 GB
Notification: Performance of collectPreVariables (initialization): time 0.0002597/11.62, allocations: 29.45 kB / 4.133 GB, free: 12.86 MB / 0.5417 GB
Notification: Performance of collectInitialEqns (initialization): time 0.0006793/11.62, allocations: 0.6248 MB / 4.134 GB, free: 12.6 MB / 0.5417 GB
Notification: Performance of collectInitialBindings (initialization): time 0.0005197/11.62, allocations: 307.6 kB / 4.134 GB, free: 12.45 MB / 0.5417 GB
Notification: Performance of simplifyInitialFunctions (initialization): time 0.0001409/11.62, allocations: 0 / 4.134 GB, free: 12.45 MB / 0.5417 GB
Notification: Performance of setup shared object (initialization): time 0.0002044/11.63, allocations: 356 kB / 4.135 GB, free: 12.14 MB / 0.5417 GB
Notification: Performance of preBalanceInitialSystem (initialization): time 0.001007/11.63, allocations: 0.5307 MB / 4.135 GB, free: 12.14 MB / 0.5417 GB
Notification: Performance of partitionIndependentBlocks (initialization): time 0.001225/11.63, allocations: 0.8863 MB / 4.136 GB, free: 11.74 MB / 0.5417 GB
Notification: Performance of analyzeInitialSystem (initialization): time 0.005615/11.63, allocations: 1.194 MB / 4.137 GB, free: 11.71 MB / 0.5417 GB
Notification: Performance of solveInitialSystemEqSystem (initialization): time 2.215e-05/11.63, allocations: 3.906 kB / 4.137 GB, free: 11.71 MB / 0.5417 GB
Notification: Performance of matching and sorting (n=158) (initialization): time 0.00881/11.64, allocations: 2.294 MB / 4.14 GB, free: 11.56 MB / 0.5417 GB
Notification: Performance of prepare postOptimizeDAE: time 0.0021/11.64, allocations: 3.757 MB / 4.143 GB, free: 7.625 MB / 0.5417 GB
Notification: Performance of postOpt simplifyComplexFunction (initialization): time 3.728e-05/11.64, allocations: 11.75 kB / 4.143 GB, free: 7.625 MB / 0.5417 GB
Notification: Performance of postOpt tearingSystem (initialization): time 0.005649/11.65, allocations: 1.05 MB / 4.144 GB, free: 7.578 MB / 0.5417 GB
Notification: Performance of postOpt solveSimpleEquations (initialization): time 0.001403/11.65, allocations: 274.2 kB / 4.144 GB, free: 7.578 MB / 0.5417 GB
Notification: Performance of postOpt calculateStrongComponentJacobians (initialization): time 0.004989/11.66, allocations: 1.776 MB / 4.146 GB, free: 7.031 MB / 0.5417 GB
Notification: Performance of postOpt simplifyAllExpressions (initialization): time 0.002563/11.66, allocations: 191.2 kB / 4.146 GB, free: 7.012 MB / 0.5417 GB
Notification: Performance of postOpt collapseArrayExpressions (initialization): time 0.0003975/11.66, allocations: 71.3 kB / 4.146 GB, free: 7.012 MB / 0.5417 GB
Notification: Performance of prepare postOptimizeDAE: time 1.635e-05/11.66, allocations: 7.812 kB / 4.146 GB, free: 7.008 MB / 0.5417 GB
Notification: Performance of postOpt replaceHomotopyWithSimplified (initialization): time 0.006764/11.67, allocations: 1.751 MB / 4.148 GB, free: 6.953 MB / 0.5417 GB
Notification: Performance of postOpt simplifyComplexFunction (initialization): time 3.863e-05/11.67, allocations: 18.33 kB / 4.148 GB, free: 6.953 MB / 0.5417 GB
Notification: Performance of postOpt tearingSystem (initialization): time 0.0007784/11.67, allocations: 188.9 kB / 4.148 GB, free: 6.941 MB / 0.5417 GB
Notification: Performance of postOpt solveSimpleEquations (initialization): time 0.001611/11.67, allocations: 350 kB / 4.149 GB, free: 6.938 MB / 0.5417 GB
Notification: Performance of postOpt calculateStrongComponentJacobians (initialization): time 0.4703/12.14, allocations: 0.7581 MB / 4.149 GB, free: 116.9 MB / 0.5417 GB
Notification: Performance of postOpt simplifyAllExpressions (initialization): time 0.002673/12.14, allocations: 145.4 kB / 4.15 GB, free: 116.9 MB / 0.5417 GB
Notification: Performance of postOpt collapseArrayExpressions (initialization): time 0.0003215/12.14, allocations: 70.31 kB / 4.15 GB, free: 116.9 MB / 0.5417 GB
Notification: Model statistics after passing the back-end for initialization:
 * Number of independent subsystems: 43
 * Number of states: 0 ()
 * Number of discrete variables: 12 (pipe2.flowModel.states[2].phase,pipe2.flowModel.states[1].phase,pipe1.flowModel.states[2].phase,pipe1.flowModel.states[1].phase,pump.heatTransfer.states[1].phase,source.medium.phase,sink.medium.phase,sink1.medium.phase,sink2.medium.phase,orifice.state_b.phase,orifice.state_a.phase,pump.monitoring.state_in.phase)
 * Number of discrete states: 0 ()
 * Top-level inputs: 0
Notification: Strong component statistics for initialization (129):
 * Single equations (assignments): 128
 * 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: 1
 * Mixed (continuous/discrete) equation systems: 0
Notification: Torn system details for strict tearing set:
 * Linear torn systems: 0
 * Non-linear torn systems: 1 {6 24}
Notification: Performance of prepare postOptimizeDAE: time 0.0006657/12.14, allocations: 137.2 kB / 4.15 GB, free: 116.8 MB / 0.5417 GB
Notification: Performance of postOpt createAliasVarsForOutputStates (simulation): time 0.009491/12.15, allocations: 1.85 MB / 4.152 GB, free: 116.7 MB / 0.5417 GB
Notification: Performance of postOpt lateInlineFunction (simulation): time 0.0004125/12.15, allocations: 118.5 kB / 4.152 GB, free: 116.7 MB / 0.5417 GB
Notification: Performance of postOpt wrapFunctionCalls (simulation): time 0.01058/12.16, allocations: 3.871 MB / 4.155 GB, free: 116.5 MB / 0.5417 GB
Notification: Performance of postOpt inlineArrayEqn (simulation): time 4.713e-05/12.16, allocations: 30.45 kB / 4.156 GB, free: 116.5 MB / 0.5417 GB
Notification: Performance of postOpt constantLinearSystem (simulation): time 1.528e-05/12.16, allocations: 0 / 4.156 GB, free: 116.5 MB / 0.5417 GB
Notification: Performance of postOpt simplifysemiLinear (simulation): time 1.813e-05/12.16, allocations: 7.938 kB / 4.156 GB, free: 116.5 MB / 0.5417 GB
Notification: Performance of postOpt removeSimpleEquations (simulation): time 0.01413/12.18, allocations: 5.316 MB / 4.161 GB, free: 116 MB / 0.5417 GB
Notification: Performance of postOpt simplifyComplexFunction (simulation): time 1.34e-05/12.18, allocations: 0 / 4.161 GB, free: 116 MB / 0.5417 GB
Notification: Performance of postOpt solveSimpleEquations (simulation): time 0.0006432/12.18, allocations: 116.5 kB / 4.161 GB, free: 116 MB / 0.5417 GB
Notification: Performance of postOpt tearingSystem (simulation): time 0.006712/12.18, allocations: 2.504 MB / 4.163 GB, free: 116 MB / 0.5417 GB
Notification: Performance of postOpt inputDerivativesUsed (simulation): time 0.0002666/12.19, allocations: 15.09 kB / 4.163 GB, free: 116 MB / 0.5417 GB
Notification: Performance of postOpt calculateStrongComponentJacobians (simulation): time 0.006503/12.19, allocations: 2.871 MB / 4.166 GB, free: 115.4 MB / 0.5417 GB
Notification: Performance of postOpt calculateStateSetsJacobians (simulation): time 1.109e-05/12.19, allocations: 5.656 kB / 4.166 GB, free: 115.4 MB / 0.5417 GB
Notification: Performance of postOpt symbolicJacobian (simulation): time 0.008384/12.2, allocations: 3.091 MB / 4.169 GB, free: 115 MB / 0.5417 GB
Notification: Performance of postOpt removeConstants (simulation): time 0.001747/12.2, allocations: 465.3 kB / 4.17 GB, free: 114.8 MB / 0.5417 GB
Notification: Performance of postOpt simplifyTimeIndepFuncCalls (simulation): time 0.0002996/12.2, allocations: 9.859 kB / 4.17 GB, free: 114.8 MB / 0.5417 GB
Notification: Performance of postOpt simplifyAllExpressions (simulation): time 0.001245/12.2, allocations: 95.19 kB / 4.17 GB, free: 114.8 MB / 0.5417 GB
Notification: Performance of postOpt findZeroCrossings (simulation): time 0.0002182/12.2, allocations: 73.31 kB / 4.17 GB, free: 114.8 MB / 0.5417 GB
Notification: Performance of postOpt collapseArrayExpressions (simulation): time 9.623e-05/12.2, allocations: 36.47 kB / 4.17 GB, free: 114.8 MB / 0.5417 GB
Notification: Performance of sorting global known variables: time 0.001885/12.21, allocations: 0.8312 MB / 4.171 GB, free: 114.7 MB / 0.5417 GB
Notification: Performance of sort global known variables: time 3.81e-07/12.21, allocations: 0 / 4.171 GB, free: 114.7 MB / 0.5417 GB
Notification: Performance of remove unused functions: time 0.01099/12.22, allocations: 1.877 MB / 4.172 GB, free: 114.7 MB / 0.5417 GB
Notification: Model statistics after passing the back-end for simulation:
 * Number of independent subsystems: 3
 * Number of states: 0 ()
 * Number of discrete variables: 15 ($cse2.region3boundary,$cse3.region3boundary,$cse4.phase,$cse4.region,$cse7.phase,$cse7.region,$cse8.phase,$cse8.region,$cse13.phase,$cse13.region,$cse15.phase,$cse15.region,$cse20.phase,$cse20.region,pump.heatTransfer.states[1].phase)
 * Number of discrete states: 0 ()
 * Top-level inputs: 0
Notification: Strong component statistics for simulation (65):
 * Single equations (assignments): 60
 * Array equations: 0
 * Algorithm blocks: 0
 * Record equations: 4
 * When equations: 0
 * If-equations: 0
 * Equation systems (linear and non-linear blocks): 0
 * Torn equation systems: 1
 * Mixed (continuous/discrete) equation systems: 0
Notification: Torn system details for strict tearing set:
 * Linear torn systems: 0
 * Non-linear torn systems: 1 {6 35}
Notification: Performance of Backend phase and start with SimCode phase: time 0.0211/12.24, allocations: 5.518 MB / 4.178 GB, free: 113.6 MB / 0.5417 GB
Notification: Performance of simCode: created initialization part: time 0.0067/12.24, allocations: 2.327 MB / 4.18 GB, free: 113.5 MB / 0.5417 GB
Notification: Performance of simCode: created event and clocks part: time 1.333e-05/12.24, allocations: 1.031 kB / 4.18 GB, free: 113.5 MB / 0.5417 GB
Notification: Performance of simCode: created simulation system equations: time 0.002164/12.25, allocations: 0.9016 MB / 4.181 GB, free: 113.5 MB / 0.5417 GB
Notification: Performance of simCode: created of all other equations (e.g. parameter, nominal, assert, etc): time 0.003613/12.25, allocations: 497.4 kB / 4.181 GB, free: 113.5 MB / 0.5417 GB
Notification: Performance of simCode: created linear, non-linear and system jacobian parts: time 0.01305/12.26, allocations: 3.104 MB / 4.184 GB, free: 112.8 MB / 0.5417 GB
Notification: Performance of simCode: some other stuff during SimCode phase: time 0.001385/12.27, allocations: 1.397 MB / 4.186 GB, free: 112.1 MB / 0.5417 GB
Notification: Performance of simCode: alias equations: time 0.004027/12.27, allocations: 1.772 MB / 4.188 GB, free: 112.1 MB / 0.5417 GB
Notification: Performance of simCode: all other stuff during SimCode phase: time 0.0009456/12.27, allocations: 0.5848 MB / 4.188 GB, free: 112.1 MB / 0.5417 GB
Notification: Performance of SimCode: time 1.963e-06/12.27, allocations: 0 / 4.188 GB, free: 112.1 MB / 0.5417 GB
Notification: Performance of buildModelFMU: Generate the FMI files: time 0.1689/12.44, allocations: 70.36 MB / 4.257 GB, free: 108.9 MB / 0.5417 GB
Notification: Performance of buildModelFMU: configured platform static using cached values: time 0.0003325/12.44, allocations: 173 kB / 4.257 GB, free: 108.7 MB / 0.5417 GB
Notification: Performance of buildModelFMU: Generate platform static: time 4.829/17.27, allocations: 4.844 kB / 4.257 GB, free: 108.7 MB / 0.5417 GB
(rm -f Modelica_4.0.0_Modelica.Fluid.Examples.InverseParameterization.pipe ; mkfifo Modelica_4.0.0_Modelica.Fluid.Examples.InverseParameterization.pipe ; head -c 1048576 < Modelica_4.0.0_Modelica.Fluid.Examples.InverseParameterization.pipe >> ../files/Modelica_4.0.0_Modelica.Fluid.Examples.InverseParameterization.sim & /home/hudson/saved_omc/OMSimulator/install/linux/bin/OMSimulator -r=Modelica_4.0.0_Modelica.Fluid.Examples.InverseParameterization_res.mat --tempDir=temp_Modelica_4_0_0_Modelica_Fluid_Examples_InverseParameterization_fmu --startTime=0 --stopTime=10 --timeout=50 --tolerance=1e-06 Modelica_4_0_0_Modelica_Fluid_Examples_InverseParameterization.fmu > Modelica_4.0.0_Modelica.Fluid.Examples.InverseParameterization.pipe 2>&1)
TODO: How the !@#!# did the simulation report success but simulation result Modelica_4.0.0_Modelica.Fluid.Examples.InverseParameterization_res.mat does not exist to compare? outputFormat=mat