Running: ./testmodel.py --libraries=/home/hudson/saved_omc/libraries/.openmodelica/libraries/ --ompython_omhome=/usr IDEAS_dev_IDEAS.Fluid.Movers.Validation.FlowControlled_m_flow.conf.json
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/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/IDEAS 3.0.0-master/package.mo", uses=false)
Using package IDEAS with version 3.0.0 (/home/hudson/saved_omc/libraries/.openmodelica/libraries/IDEAS 3.0.0-master/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)
Using package ModelicaServices with version 4.0.0 (/home/hudson/saved_omc/libraries/.openmodelica/libraries/ModelicaServices 4.0.0+maint.om/package.mo)
Running command: "" <> buildModelFMU(IDEAS.Fluid.Movers.Validation.FlowControlled_m_flow,fileNamePrefix="IDEAS_dev_IDEAS_Fluid_Movers_Validation_FlowControlled_m_flow",fmuType="me",version="2.0",platforms={"static"})
"" <> buildModelFMU(IDEAS.Fluid.Movers.Validation.FlowControlled_m_flow,fileNamePrefix="IDEAS_dev_IDEAS_Fluid_Movers_Validation_FlowControlled_m_flow",fmuType="me",version="2.0",platforms={"static"})
Notification: Performance of loadFile(/home/hudson/saved_omc/libraries/.openmodelica/libraries/ModelicaServices 4.0.0+maint.om/package.mo): time 0.001487/0.001487, allocations: 100.2 kB / 15.05 MB, free: 1.105 MB / 14.72 MB
Notification: Performance of loadFile(/home/hudson/saved_omc/libraries/.openmodelica/libraries/Complex 4.0.0+maint.om/package.mo): time 0.00245/0.002451, allocations: 177.3 kB / 15.95 MB, free: 216 kB / 14.72 MB
Notification: Performance of loadFile(/home/hudson/saved_omc/libraries/.openmodelica/libraries/Modelica 4.0.0+maint.om/package.mo): time 2.406/2.406, allocations: 223.2 MB / 239.9 MB, free: 5.383 MB / 190.1 MB
Notification: Performance of loadFile(/home/hudson/saved_omc/libraries/.openmodelica/libraries/IDEAS 3.0.0-master/package.mo): time 1.557/1.557, allocations: 135.2 MB / 426.2 MB, free: 14.33 MB / 350.1 MB
Notification: Performance of FrontEnd - loaded program: time 0.0006294/0.0006296, allocations: 11.98 kB / 0.5069 GB, free: 5.176 MB / 414.1 MB
Notification: Performance of FrontEnd - Absyn->SCode: time 0.2387/0.2394, allocations: 82.32 MB / 0.5873 GB, free: 3.039 MB / 494.1 MB
Notification: Performance of NFInst.instantiate(IDEAS.Fluid.Movers.Validation.FlowControlled_m_flow): time 0.9867/1.226, allocations: 262.1 MB / 0.8432 GB, free: 6.211 MB / 0.6544 GB
Notification: Performance of NFInst.instExpressions: time 0.04916/1.275, allocations: 18.46 MB / 0.8613 GB, free: 3.723 MB / 0.67 GB
Notification: Performance of NFInst.updateImplicitVariability: time 0.006065/1.282, allocations: 75.5 kB / 0.8613 GB, free: 3.648 MB / 0.67 GB
Notification: Performance of NFTyping.typeComponents: time 0.007586/1.289, allocations: 1.205 MB / 0.8625 GB, free: 2.438 MB / 0.67 GB
Notification: Performance of NFTyping.typeBindings: time 0.6416/1.931, allocations: 3.846 MB / 0.8663 GB, free: 56 MB / 0.67 GB
Notification: Performance of NFTyping.typeClassSections: time 0.01075/1.942, allocations: 2.105 MB / 0.8683 GB, free: 55.99 MB / 0.67 GB
Notification: Performance of NFFlatten.flatten: time 0.01221/1.954, allocations: 3.437 MB / 0.8717 GB, free: 55.98 MB / 0.67 GB
Notification: Performance of NFFlatten.resolveConnections: time 0.006139/1.96, allocations: 1.606 MB / 0.8733 GB, free: 55.81 MB / 0.67 GB
Notification: Performance of NFEvalConstants.evaluate: time 0.01088/1.971, allocations: 2.253 MB / 0.8755 GB, free: 55.8 MB / 0.67 GB
Notification: Performance of NFSimplifyModel.simplify: time 0.004345/1.975, allocations: 1.144 MB / 0.8766 GB, free: 55.79 MB / 0.67 GB
Notification: Performance of NFPackage.collectConstants: time 0.0009897/1.976, allocations: 89.31 kB / 0.8767 GB, free: 55.79 MB / 0.67 GB
Notification: Performance of NFFlatten.collectFunctions: time 0.009381/1.986, allocations: 1.869 MB / 0.8785 GB, free: 55.79 MB / 0.67 GB
Notification: Performance of NFScalarize.scalarize: time 0.002325/1.988, allocations: 0.6713 MB / 0.8791 GB, free: 55.79 MB / 0.67 GB
Notification: Performance of NFVerifyModel.verify: time 0.00194/1.99, allocations: 0.5122 MB / 0.8796 GB, free: 55.76 MB / 0.67 GB
Notification: Performance of NFConvertDAE.convert: time 0.009324/2, allocations: 3.134 MB / 0.8827 GB, free: 55.52 MB / 0.67 GB
Notification: Performance of FrontEnd - DAE generated: time 5.37e-06/2, allocations: 0 / 0.8827 GB, free: 55.52 MB / 0.67 GB
Notification: Performance of FrontEnd: time 3.617e-06/2, allocations: 0 / 0.8827 GB, free: 55.52 MB / 0.67 GB
Notification: Performance of Transformations before backend: time 0.0001641/2, allocations: 1.562 kB / 0.8827 GB, free: 55.52 MB / 0.67 GB
Notification: Model statistics after passing the front-end and creating the data structures used by the back-end:
 * Number of equations: 341
 * Number of variables: 341
Notification: Performance of Generate backend data structure: time 0.01005/2.01, allocations: 2.514 MB / 0.8852 GB, free: 54.18 MB / 0.67 GB
Notification: Performance of prepare preOptimizeDAE: time 5.991e-05/2.01, allocations: 9.641 kB / 0.8852 GB, free: 54.18 MB / 0.67 GB
Notification: Performance of preOpt introduceOutputAliases (simulation): time 0.001009/2.011, allocations: 197.8 kB / 0.8854 GB, free: 54.14 MB / 0.67 GB
Notification: Performance of preOpt normalInlineFunction (simulation): time 0.01164/2.023, allocations: 0.8803 MB / 0.8862 GB, free: 53.97 MB / 0.67 GB
Notification: Performance of preOpt evaluateParameters (simulation): time 0.008652/2.031, allocations: 1.815 MB / 0.888 GB, free: 53.5 MB / 0.67 GB
Notification: Performance of preOpt simplifyIfEquations (simulation): time 0.0007915/2.032, allocations: 179.5 kB / 0.8882 GB, free: 53.49 MB / 0.67 GB
Notification: Performance of preOpt expandDerOperator (simulation): time 0.0008569/2.033, allocations: 155.6 kB / 0.8883 GB, free: 53.49 MB / 0.67 GB
Notification: Performance of preOpt clockPartitioning (simulation): time 0.007631/2.041, allocations: 1.676 MB / 0.8899 GB, free: 53.31 MB / 0.67 GB
Notification: Performance of preOpt findStateOrder (simulation): time 6.129e-05/2.041, allocations: 2.016 kB / 0.8899 GB, free: 53.31 MB / 0.67 GB
Notification: Performance of preOpt replaceEdgeChange (simulation): time 0.000266/2.041, allocations: 55.66 kB / 0.89 GB, free: 53.31 MB / 0.67 GB
Notification: Performance of preOpt inlineArrayEqn (simulation): time 0.000134/2.041, allocations: 54.02 kB / 0.8901 GB, free: 53.3 MB / 0.67 GB
Notification: Performance of preOpt removeEqualRHS (simulation): time 0.008661/2.05, allocations: 1.476 MB / 0.8915 GB, free: 53.27 MB / 0.67 GB
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.02273/2.073, allocations: 7.811 MB / 0.8991 GB, free: 49.34 MB / 0.67 GB
Notification: Performance of preOpt comSubExp (simulation): time 0.004626/2.078, allocations: 1.12 MB / 0.9002 GB, free: 49.11 MB / 0.67 GB
Notification: Performance of preOpt evalFunc (simulation): time 0.0001471/2.078, allocations: 24.02 kB / 0.9002 GB, free: 49.11 MB / 0.67 GB
Notification: Performance of preOpt encapsulateWhenConditions (simulation): time 3.714e-05/2.078, allocations: 43.94 kB / 0.9003 GB, free: 49.07 MB / 0.67 GB
Notification: Performance of preOpt simplifyInStream (simulation): time 0.002049/2.08, allocations: 194.2 kB / 0.9005 GB, free: 49.02 MB / 0.67 GB
Notification: Performance of pre-optimization done (n=77): time 7.564e-06/2.08, allocations: 1.719 kB / 0.9005 GB, free: 49.02 MB / 0.67 GB
Notification: Performance of matching and sorting (n=77): time 0.008295/2.088, allocations: 1.513 MB / 0.9019 GB, free: 48.85 MB / 0.67 GB
Notification: Performance of inlineWhenForInitialization (initialization): time 6.899e-05/2.088, allocations: 70.14 kB / 0.902 GB, free: 48.79 MB / 0.67 GB
Notification: Performance of selectInitializationVariablesDAE (initialization): time 0.005233/2.094, allocations: 1.782 MB / 0.9038 GB, free: 48.56 MB / 0.67 GB
Notification: Performance of collectPreVariables (initialization): time 0.0004405/2.094, allocations: 48.53 kB / 0.9038 GB, free: 48.53 MB / 0.67 GB
Notification: Performance of collectInitialEqns (initialization): time 0.001305/2.095, allocations: 0.9785 MB / 0.9048 GB, free: 48.22 MB / 0.67 GB
Notification: Performance of collectInitialBindings (initialization): time 0.0005818/2.096, allocations: 267.8 kB / 0.905 GB, free: 48.05 MB / 0.67 GB
Notification: Performance of simplifyInitialFunctions (initialization): time 0.0001002/2.096, allocations: 22.23 kB / 0.905 GB, free: 48.05 MB / 0.67 GB
Notification: Performance of setup shared object (initialization): time 0.0001264/2.096, allocations: 345.4 kB / 0.9054 GB, free: 47.75 MB / 0.67 GB
Notification: Performance of preBalanceInitialSystem (initialization): time 0.002407/2.099, allocations: 472.6 kB / 0.9058 GB, free: 47.73 MB / 0.67 GB
Notification: Performance of partitionIndependentBlocks (initialization): time 0.002733/2.101, allocations: 0.8721 MB / 0.9067 GB, free: 47.23 MB / 0.67 GB
Notification: Performance of analyzeInitialSystem (initialization): time 0.002746/2.104, allocations: 0.5597 MB / 0.9072 GB, free: 47.2 MB / 0.67 GB
Notification: Performance of solveInitialSystemEqSystem (initialization): time 2.274e-05/2.104, allocations: 3.75 kB / 0.9072 GB, free: 47.2 MB / 0.67 GB
Notification: Performance of matching and sorting (n=127) (initialization): time 0.007096/2.111, allocations: 1.465 MB / 0.9086 GB, free: 47.04 MB / 0.67 GB
Notification: Performance of prepare postOptimizeDAE: time 0.0009812/2.112, allocations: 3.966 MB / 0.9125 GB, free: 42.76 MB / 0.67 GB
Notification: Performance of postOpt simplifyComplexFunction (initialization): time 3.919e-05/2.113, allocations: 9.906 kB / 0.9125 GB, free: 42.76 MB / 0.67 GB
Notification: Performance of postOpt tearingSystem (initialization): time 5.366e-05/2.113, allocations: 20.28 kB / 0.9125 GB, free: 42.75 MB / 0.67 GB
Notification: Performance of postOpt solveSimpleEquations (initialization): time 0.003028/2.116, allocations: 307.7 kB / 0.9128 GB, free: 42.75 MB / 0.67 GB
Notification: Performance of postOpt calculateStrongComponentJacobians (initialization): time 0.0005403/2.116, allocations: 0.6133 MB / 0.9134 GB, free: 42.16 MB / 0.67 GB
Notification: Performance of postOpt simplifyAllExpressions (initialization): time 0.004572/2.121, allocations: 187.2 kB / 0.9136 GB, free: 42.14 MB / 0.67 GB
Notification: Performance of postOpt collapseArrayExpressions (initialization): time 0.0003948/2.121, allocations: 55.02 kB / 0.9137 GB, free: 42.14 MB / 0.67 GB
Notification: Performance of prepare postOptimizeDAE: time 2.143e-05/2.121, allocations: 5.969 kB / 0.9137 GB, free: 42.14 MB / 0.67 GB
Notification: Performance of postOpt replaceHomotopyWithSimplified (initialization): time 0.004958/2.126, allocations: 1.16 MB / 0.9148 GB, free: 42.11 MB / 0.67 GB
Notification: Performance of postOpt simplifyComplexFunction (initialization): time 4.185e-05/2.126, allocations: 10.09 kB / 0.9148 GB, free: 42.11 MB / 0.67 GB
Notification: Performance of postOpt tearingSystem (initialization): time 3.273e-05/2.126, allocations: 18.66 kB / 0.9148 GB, free: 42.11 MB / 0.67 GB
Notification: Performance of postOpt solveSimpleEquations (initialization): time 0.002112/2.129, allocations: 266.1 kB / 0.9151 GB, free: 42.1 MB / 0.67 GB
Notification: Performance of postOpt calculateStrongComponentJacobians (initialization): time 4.397e-05/2.129, allocations: 25.23 kB / 0.9151 GB, free: 42.1 MB / 0.67 GB
Notification: Performance of postOpt simplifyAllExpressions (initialization): time 0.003885/2.132, allocations: 159.9 kB / 0.9153 GB, free: 42.08 MB / 0.67 GB
Notification: Performance of postOpt collapseArrayExpressions (initialization): time 0.000291/2.133, allocations: 53.33 kB / 0.9153 GB, free: 42.08 MB / 0.67 GB
Notification: Model statistics after passing the back-end for initialization:
 * Number of independent subsystems: 43
 * Number of states: 0 ()
 * Number of discrete variables: 0 ()
 * Number of discrete states: 0 ()
 * Number of clocked states: 0 ()
 * Top-level inputs: 0
Notification: Strong component statistics for initialization (125):
 * Single equations (assignments): 122
 * Array equations: 2
 * Algorithm blocks: 0
 * Record equations: 0
 * When equations: 0
 * If-equations: 0
 * Equation systems (linear and non-linear blocks): 1
 * Torn equation systems: 0
 * Mixed (continuous/discrete) equation systems: 0
Notification: Equation system details:
 * Constant Jacobian: 0
 * Linear Jacobian (size,density): 0
 * Non-linear Jacobian: 1 {1}
 * Without analytic Jacobian: 0
Notification: Performance of prepare postOptimizeDAE: time 0.002472/2.135, allocations: 0.582 MB / 0.9159 GB, free: 41.88 MB / 0.67 GB
Notification: Performance of postOpt lateInlineFunction (simulation): time 0.0009971/2.136, allocations: 196.1 kB / 0.9161 GB, free: 41.78 MB / 0.67 GB
Notification: Performance of postOpt wrapFunctionCalls (simulation): time 0.006209/2.143, allocations: 1.182 MB / 0.9172 GB, free: 41.69 MB / 0.67 GB
Notification: Performance of postOpt inlineArrayEqn (simulation): time 2.19e-05/2.143, allocations: 7.719 kB / 0.9172 GB, free: 41.69 MB / 0.67 GB
Notification: Performance of postOpt constantLinearSystem (simulation): time 1.35e-05/2.143, allocations: 4.562 kB / 0.9172 GB, free: 41.69 MB / 0.67 GB
Notification: Performance of postOpt simplifysemiLinear (simulation): time 0.004562/2.147, allocations: 1.005 MB / 0.9182 GB, free: 41.51 MB / 0.67 GB
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 postOpt removeSimpleEquations (simulation): time 0.01273/2.16, allocations: 2.981 MB / 0.9211 GB, free: 40.95 MB / 0.67 GB
Notification: Performance of postOpt simplifyComplexFunction (simulation): time 1.187e-05/2.16, allocations: 0 / 0.9211 GB, free: 40.95 MB / 0.67 GB
Notification: Performance of postOpt solveSimpleEquations (simulation): time 0.00226/2.162, allocations: 244.6 kB / 0.9214 GB, free: 40.94 MB / 0.67 GB
Notification: Performance of postOpt tearingSystem (simulation): time 2.468e-05/2.162, allocations: 5.344 kB / 0.9214 GB, free: 40.94 MB / 0.67 GB
Notification: Performance of postOpt inputDerivativesUsed (simulation): time 0.00014/2.163, allocations: 27.06 kB / 0.9214 GB, free: 40.94 MB / 0.67 GB
Notification: Performance of postOpt calculateStrongComponentJacobians (simulation): time 0.0003572/2.163, allocations: 0.5901 MB / 0.922 GB, free: 40.36 MB / 0.67 GB
Notification: Performance of postOpt calculateStateSetsJacobians (simulation): time 5.851e-06/2.163, allocations: 2.781 kB / 0.922 GB, free: 40.36 MB / 0.67 GB
Notification: Performance of postOpt symbolicJacobian (simulation): time 0.007477/2.171, allocations: 1.881 MB / 0.9238 GB, free: 39.89 MB / 0.67 GB
Notification: Performance of postOpt removeConstants (simulation): time 0.001916/2.172, allocations: 363.9 kB / 0.9242 GB, free: 39.7 MB / 0.67 GB
Notification: Performance of postOpt simplifyTimeIndepFuncCalls (simulation): time 0.0008744/2.173, allocations: 18.59 kB / 0.9242 GB, free: 39.7 MB / 0.67 GB
Notification: Performance of postOpt simplifyAllExpressions (simulation): time 0.003637/2.177, allocations: 164.4 kB / 0.9243 GB, free: 39.68 MB / 0.67 GB
Notification: Performance of postOpt findZeroCrossings (simulation): time 0.0002426/2.177, allocations: 52.97 kB / 0.9244 GB, free: 39.67 MB / 0.67 GB
Notification: Performance of postOpt collapseArrayExpressions (simulation): time 0.0001678/2.178, allocations: 36.38 kB / 0.9244 GB, free: 39.67 MB / 0.67 GB
Notification: Performance of sorting global known variables: time 0.003509/2.181, allocations: 1.211 MB / 0.9256 GB, free: 39.53 MB / 0.67 GB
Notification: Performance of sort global known variables: time 9.31e-07/2.181, allocations: 0 / 0.9256 GB, free: 39.53 MB / 0.67 GB
Notification: Performance of remove unused functions: time 0.006537/2.188, allocations: 0.9954 MB / 0.9266 GB, free: 39.39 MB / 0.67 GB
Notification: Model statistics after passing the back-end for simulation:
 * Number of independent subsystems: 6
 * Number of states: 3 (floMacDyn.vol.dynBal.U,floMacDyn.vol.dynBal.m,floMacDyn.vol.dynBal.mXi[1])
 * Number of discrete variables: 0 ()
 * Number of discrete states: 0 ()
 * Number of clocked states: 0 ()
 * Top-level inputs: 0
Notification: Strong component statistics for simulation (79):
 * Single equations (assignments): 78
 * Array equations: 0
 * Algorithm blocks: 0
 * Record equations: 0
 * When equations: 0
 * If-equations: 0
 * Equation systems (linear and non-linear blocks): 1
 * Torn equation systems: 0
 * Mixed (continuous/discrete) equation systems: 0
Notification: Equation system details:
 * Constant Jacobian: 0
 * Linear Jacobian (size,density): 0
 * Non-linear Jacobian: 1 {1}
 * Without analytic Jacobian: 0
Notification: Performance of Backend phase and start with SimCode phase: time 0.009267/2.197, allocations: 2.996 MB / 0.9295 GB, free: 38.07 MB / 0.67 GB
Notification: Performance of simCode: created initialization part: time 0.007829/2.205, allocations: 1.718 MB / 0.9312 GB, free: 38.02 MB / 0.67 GB
Notification: Performance of simCode: created event and clocks part: time 1.322e-05/2.205, allocations: 0 / 0.9312 GB, free: 38.02 MB / 0.67 GB
Notification: Performance of simCode: created simulation system equations: time 0.002427/2.207, allocations: 0.5125 MB / 0.9317 GB, free: 38 MB / 0.67 GB
Notification: Performance of simCode: created of all other equations (e.g. parameter, nominal, assert, etc): time 0.009325/2.217, allocations: 1.011 MB / 0.9327 GB, free: 37.92 MB / 0.67 GB
Notification: Performance of simCode: created linear, non-linear and system jacobian parts: time 0.01929/2.236, allocations: 11.82 MB / 0.9442 GB, free: 28.79 MB / 0.67 GB
Notification: Performance of simCode: some other stuff during SimCode phase: time 0.001666/2.238, allocations: 1.609 MB / 0.9458 GB, free: 27.83 MB / 0.67 GB
Notification: Performance of simCode: alias equations: time 0.004061/2.242, allocations: 0.5013 MB / 0.9463 GB, free: 27.58 MB / 0.67 GB
Notification: Performance of simCode: all other stuff during SimCode phase: time 0.00206/2.244, allocations: 0.8673 MB / 0.9471 GB, free: 27.49 MB / 0.67 GB
Notification: Performance of SimCode: time 1.192e-06/2.244, allocations: 0 / 0.9471 GB, free: 27.49 MB / 0.67 GB
Notification: Performance of buildModelFMU: Generate the FMI files: time 0.1519/2.396, allocations: 54.49 MB / 1 GB, free: 11.43 MB / 0.7012 GB
Notification: Performance of buildModelFMU: configured platform static using cached values: time 0.0003791/2.396, allocations: 252.3 kB / 1.001 GB, free: 11.1 MB / 0.7012 GB
Notification: Performance of buildModelFMU: Generate platform static: time 5.67/8.067, allocations: 4 kB / 1.001 GB, free: 11.09 MB / 0.7012 GB
(rm -f IDEAS_dev_IDEAS.Fluid.Movers.Validation.FlowControlled_m_flow.pipe ; mkfifo IDEAS_dev_IDEAS.Fluid.Movers.Validation.FlowControlled_m_flow.pipe ; head -c 1048576 < IDEAS_dev_IDEAS.Fluid.Movers.Validation.FlowControlled_m_flow.pipe >> ../files/IDEAS_dev_IDEAS.Fluid.Movers.Validation.FlowControlled_m_flow.sim & /home/hudson/saved_omc/OMSimulator/install/linux/bin/OMSimulator  --tempDir=temp_IDEAS_dev_IDEAS_Fluid_Movers_Validation_FlowControlled_m_flow_fmu --startTime=0 --stopTime=1 --timeout=50 --tolerance=1e-06 IDEAS_dev_IDEAS_Fluid_Movers_Validation_FlowControlled_m_flow.fmu > IDEAS_dev_IDEAS.Fluid.Movers.Validation.FlowControlled_m_flow.pipe 2>&1)
Environment - environmentSimulation: