Running: ./testmodel.py --libraries=/home/hudson/saved_omc/libraries/.openmodelica/libraries/ --ompython_omhome=/usr Buildings_9_Buildings.Examples.Tutorial.Boiler.System4.conf.json
loadFile("/home/hudson/saved_omc/libraries/.openmodelica/libraries/Buildings 9.1.1-maint.9.1.x/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/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)
Using package Buildings with version 9.1.1 (/home/hudson/saved_omc/libraries/.openmodelica/libraries/Buildings 9.1.1-maint.9.1.x/package.mo)
Running command: "" <> buildModelFMU(Buildings.Examples.Tutorial.Boiler.System4,fileNamePrefix="Buildings_9_Buildings_Examples_Tutorial_Boiler_System4",fmuType="me",version="2.0",platforms={"static"})
"" <> buildModelFMU(Buildings.Examples.Tutorial.Boiler.System4,fileNamePrefix="Buildings_9_Buildings_Examples_Tutorial_Boiler_System4",fmuType="me",version="2.0",platforms={"static"})
Notification: Performance of loadFile(/home/hudson/saved_omc/libraries/.openmodelica/libraries/Buildings 9.1.1-maint.9.1.x/package.mo): time 2.485/2.485, allocations: 390.3 MB / 405.3 MB, free: 13.46 MB / 314.7 MB
Notification: Performance of loadFile(/home/hudson/saved_omc/libraries/.openmodelica/libraries/Complex 4.0.0+maint.om/package.mo): time 0.001202/0.001202, allocations: 181.1 kB / 498.1 MB, free: 5.727 MB / 394.7 MB
Notification: Performance of loadFile(/home/hudson/saved_omc/libraries/.openmodelica/libraries/Modelica 4.0.0+maint.om/package.mo): time 1.646/1.646, allocations: 223.1 MB / 0.7948 GB, free: 17.93 MB / 0.5573 GB
Notification: Performance of loadFile(/home/hudson/saved_omc/libraries/.openmodelica/libraries/ModelicaServices 4.0.0+maint.om/package.mo): time 0.0009625/0.0009626, allocations: 96.33 kB / 0.9346 GB, free: 6.219 MB / 0.6823 GB
Notification: Performance of FrontEnd - loaded program: time 0.0003867/0.0003863, allocations: 12.16 kB / 1.084 GB, free: 221.2 MB / 0.823 GB
Notification: Performance of FrontEnd - Absyn->SCode: time 0.3202/0.3206, allocations: 142.3 MB / 1.223 GB, free: 114.2 MB / 0.823 GB
Notification: Performance of FrontEnd - scodeFlatten: time 6.334/6.655, allocations: 2.223 GB / 3.446 GB, free: 261.3 MB / 1.167 GB
Notification: Performance of FrontEnd - mkProgramGraph: time 0.0003604/6.655, allocations: 92.52 kB / 3.446 GB, free: 261.2 MB / 1.167 GB
Notification: Performance of FrontEnd - DAE generated: time 18.61/25.26, allocations: 4.415 GB / 7.861 GB, free: 33.95 MB / 1.323 GB
Notification: Performance of FrontEnd: time 3.707e-06/25.26, allocations: 0 / 7.861 GB, free: 33.95 MB / 1.323 GB
Notification: Performance of Transformations before backend: time 0.002759/25.27, allocations: 301.7 kB / 7.861 GB, free: 33.65 MB / 1.323 GB
Notification: Model statistics after passing the front-end and creating the data structures used by the back-end:
 * Number of equations: 1620
 * Number of variables: 1620
Notification: Performance of Generate backend data structure: time 0.04846/25.31, allocations: 11.46 MB / 7.872 GB, free: 22.08 MB / 1.323 GB
Notification: Performance of prepare preOptimizeDAE: time 6.196e-05/25.31, allocations: 8.031 kB / 7.872 GB, free: 22.07 MB / 1.323 GB
Notification: Performance of preOpt introduceOutputAliases (simulation): time 0.005498/25.32, allocations: 0.8317 MB / 7.873 GB, free: 21.23 MB / 1.323 GB
Notification: Performance of preOpt normalInlineFunction (simulation): time 0.01587/25.34, allocations: 2.215 MB / 7.875 GB, free: 19 MB / 1.323 GB
Notification: Performance of preOpt evaluateParameters (simulation): time 0.04645/25.38, allocations: 12.84 MB / 7.888 GB, free: 6.051 MB / 1.323 GB
Notification: Performance of preOpt simplifyIfEquations (simulation): time 0.0008669/25.38, allocations: 0.5122 MB / 7.889 GB, free: 5.535 MB / 1.323 GB
Notification: Performance of preOpt expandDerOperator (simulation): time 0.003745/25.39, allocations: 0.6794 MB / 7.889 GB, free: 4.855 MB / 1.323 GB
Notification: Performance of preOpt clockPartitioning (simulation): time 0.03024/25.42, allocations: 7.413 MB / 7.896 GB, free: 13.16 MB / 1.339 GB
Notification: Performance of preOpt findStateOrder (simulation): time 0.0005637/25.42, allocations: 19.78 kB / 7.896 GB, free: 13.14 MB / 1.339 GB
Notification: Performance of preOpt replaceEdgeChange (simulation): time 0.003281/25.42, allocations: 272 kB / 7.897 GB, free: 12.87 MB / 1.339 GB
Notification: Performance of preOpt inlineArrayEqn (simulation): time 0.0004131/25.42, allocations: 268 kB / 7.897 GB, free: 12.61 MB / 1.339 GB
Notification: Performance of preOpt removeEqualRHS (simulation): time 0.0219/25.44, allocations: 5.778 MB / 7.903 GB, free: 6.809 MB / 1.339 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 1.321/26.76, allocations: 37.97 MB / 7.94 GB, free: 92.16 MB / 1.37 GB
Notification: Performance of preOpt comSubExp (simulation): time 0.009273/26.77, allocations: 4.103 MB / 7.944 GB, free: 91.46 MB / 1.37 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 evalFunc (simulation): time 0.03578/26.81, allocations: 9.371 MB / 7.953 GB, free: 88.88 MB / 1.37 GB
Notification: Performance of preOpt encapsulateWhenConditions (simulation): time 0.007167/26.82, allocations: 2.218 MB / 7.955 GB, free: 88.75 MB / 1.37 GB
Notification: Performance of preOpt simplifyInStream (simulation): time 0.007719/26.82, allocations: 467.4 kB / 7.955 GB, free: 88.75 MB / 1.37 GB
Notification: Performance of pre-optimization done (n=352): time 4.134e-05/26.82, allocations: 0 / 7.955 GB, free: 88.75 MB / 1.37 GB
Notification: Performance of matching and sorting (n=360): time 0.04813/26.87, allocations: 12.78 MB / 7.968 GB, free: 86.67 MB / 1.37 GB
Notification: Performance of inlineWhenForInitialization (initialization): time 8.722e-05/26.87, allocations: 113.3 kB / 7.968 GB, free: 86.57 MB / 1.37 GB
Notification: Performance of selectInitializationVariablesDAE (initialization): time 0.02018/26.89, allocations: 6.826 MB / 7.975 GB, free: 86.1 MB / 1.37 GB
Notification: Performance of collectPreVariables (initialization): time 0.001558/26.89, allocations: 128.1 kB / 7.975 GB, free: 86.07 MB / 1.37 GB
Notification: Performance of collectInitialEqns (initialization): time 0.007331/26.9, allocations: 4.577 MB / 7.979 GB, free: 85.13 MB / 1.37 GB
Notification: Performance of collectInitialBindings (initialization): time 0.002634/26.9, allocations: 1.263 MB / 7.981 GB, free: 84.5 MB / 1.37 GB
Notification: Performance of simplifyInitialFunctions (initialization): time 0.001217/26.91, allocations: 97.62 kB / 7.981 GB, free: 84.5 MB / 1.37 GB
Notification: Performance of setup shared object (initialization): time 0.0005489/26.91, allocations: 0.4963 MB / 7.981 GB, free: 84.18 MB / 1.37 GB
Notification: Performance of preBalanceInitialSystem (initialization): time 0.004763/26.91, allocations: 1.788 MB / 7.983 GB, free: 84.16 MB / 1.37 GB
Notification: Performance of partitionIndependentBlocks (initialization): time 0.005935/26.92, allocations: 3.531 MB / 7.986 GB, free: 82.13 MB / 1.37 GB
Notification: Performance of analyzeInitialSystem (initialization): time 0.005286/26.92, allocations: 2.354 MB / 7.989 GB, free: 82.07 MB / 1.37 GB
Notification: Performance of solveInitialSystemEqSystem (initialization): time 3.468e-05/26.92, allocations: 10.69 kB / 7.989 GB, free: 82.07 MB / 1.37 GB
Notification: Performance of matching and sorting (n=635) (initialization): time 0.01656/26.94, allocations: 6.518 MB / 7.995 GB, free: 81.46 MB / 1.37 GB
Notification: Performance of prepare postOptimizeDAE: time 0.004567/26.94, allocations: 21.42 MB / 8.016 GB, free: 59.22 MB / 1.37 GB
Notification: Performance of postOpt simplifyComplexFunction (initialization): time 0.000108/26.94, allocations: 45.33 kB / 8.016 GB, free: 59.21 MB / 1.37 GB
Notification: Performance of postOpt tearingSystem (initialization): time 0.003712/26.95, allocations: 0.9119 MB / 8.017 GB, free: 59.17 MB / 1.37 GB
Notification: Performance of postOpt solveSimpleEquations (initialization): time 0.005625/26.95, allocations: 1.075 MB / 8.018 GB, free: 59.17 MB / 1.37 GB
Notification: Performance of postOpt calculateStrongComponentJacobians (initialization): time 0.005893/26.96, allocations: 5.932 MB / 8.024 GB, free: 54.86 MB / 1.37 GB
Notification: Performance of postOpt simplifyAllExpressions (initialization): time 0.01126/26.97, allocations: 0.7108 MB / 8.024 GB, free: 54.82 MB / 1.37 GB
Notification: Performance of postOpt collapseArrayExpressions (initialization): time 0.001603/26.97, allocations: 244.6 kB / 8.025 GB, free: 54.82 MB / 1.37 GB
Notification: Performance of prepare postOptimizeDAE: time 1.687e-05/26.97, allocations: 9.734 kB / 8.025 GB, free: 54.82 MB / 1.37 GB
Notification: Performance of postOpt replaceHomotopyWithSimplified (initialization): time 0.0125/26.98, allocations: 5.614 MB / 8.03 GB, free: 54.68 MB / 1.37 GB
Notification: Performance of postOpt simplifyComplexFunction (initialization): time 0.0001259/26.98, allocations: 36.16 kB / 8.03 GB, free: 54.68 MB / 1.37 GB
Notification: Performance of postOpt tearingSystem (initialization): time 0.003098/26.99, allocations: 0.8412 MB / 8.031 GB, free: 54.64 MB / 1.37 GB
Notification: Performance of postOpt solveSimpleEquations (initialization): time 0.004909/26.99, allocations: 1.05 MB / 8.032 GB, free: 54.64 MB / 1.37 GB
Notification: Performance of postOpt calculateStrongComponentJacobians (initialization): time 0.009907/27, allocations: 7.821 MB / 8.04 GB, free: 50 MB / 1.37 GB
Notification: Performance of postOpt simplifyAllExpressions (initialization): time 0.01087/27.01, allocations: 0.6737 MB / 8.04 GB, free: 49.96 MB / 1.37 GB
Notification: Performance of postOpt collapseArrayExpressions (initialization): time 0.001548/27.02, allocations: 231.1 kB / 8.04 GB, free: 49.96 MB / 1.37 GB
Notification: Model statistics after passing the back-end for initialization:
 * Number of independent subsystems: 175
 * Number of states: 0 ()
 * Number of discrete variables: 13 ($whenCondition1,$PRE.timTab.tab.nextTimeEvent,timTab.tab.nextTimeEvent,$PRE.timTab.tab.nextTimeEventScaled,timTab.tab.nextTimeEventScaled,$PRE.hysTOut.y,hysTOut.y,$PRE.hysTBoi.y,hysTBoi.y,and1.y,and2.y,$PRE.hysPum.y,hysPum.y)
 * Number of discrete states: 0 ()
 * Number of clocked states: 0 ()
 * Top-level inputs: 0
Notification: Strong component statistics for initialization (580):
 * Single equations (assignments): 573
 * 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: 4
 * 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: Torn system details for strict tearing set:
 * Linear torn systems: 2 {(2,100.0%) 4,(1,100.0%) 4}
 * Non-linear torn systems: 2 {4 7,13 22}
Notification: Performance of prepare postOptimizeDAE: time 0.008459/27.02, allocations: 2.129 MB / 8.043 GB, free: 49.78 MB / 1.37 GB
Notification: Performance of postOpt lateInlineFunction (simulation): time 0.003228/27.03, allocations: 0.8296 MB / 8.043 GB, free: 49.34 MB / 1.37 GB
Notification: Performance of postOpt wrapFunctionCalls (simulation): time 0.01334/27.04, allocations: 5.33 MB / 8.049 GB, free: 49 MB / 1.37 GB
Notification: Performance of postOpt inlineArrayEqn (simulation): time 4.465e-05/27.04, allocations: 47.86 kB / 8.049 GB, free: 49 MB / 1.37 GB
Notification: Performance of postOpt constantLinearSystem (simulation): time 1.281e-05/27.04, allocations: 3.594 kB / 8.049 GB, free: 49 MB / 1.37 GB
Notification: Performance of postOpt simplifysemiLinear (simulation): time 0.008106/27.05, allocations: 3.952 MB / 8.052 GB, free: 48.75 MB / 1.37 GB
Notification: Performance of postOpt removeSimpleEquations (simulation): time 0.03567/27.08, allocations: 12.48 MB / 8.065 GB, free: 47.87 MB / 1.37 GB
Notification: Performance of postOpt simplifyComplexFunction (simulation): time 1.36e-05/27.08, allocations: 0 / 8.065 GB, free: 47.87 MB / 1.37 GB
Notification: Performance of postOpt solveSimpleEquations (simulation): time 0.003431/27.09, allocations: 0.6932 MB / 8.065 GB, free: 47.87 MB / 1.37 GB
Notification: Performance of postOpt tearingSystem (simulation): time 0.001668/27.09, allocations: 0.6119 MB / 8.066 GB, free: 47.8 MB / 1.37 GB
Notification: Performance of postOpt inputDerivativesUsed (simulation): time 0.0004667/27.09, allocations: 110.1 kB / 8.066 GB, free: 47.8 MB / 1.37 GB
Notification: Performance of postOpt calculateStrongComponentJacobians (simulation): time 0.007201/27.1, allocations: 11.61 MB / 8.077 GB, free: 37.85 MB / 1.37 GB
Notification: Performance of postOpt calculateStateSetsJacobians (simulation): time 4.308e-06/27.1, allocations: 5.656 kB / 8.077 GB, free: 37.85 MB / 1.37 GB
Notification: Performance of postOpt symbolicJacobian (simulation): time 0.01495/27.11, allocations: 7.313 MB / 8.085 GB, free: 36.86 MB / 1.37 GB
Notification: Performance of postOpt removeConstants (simulation): time 0.007282/27.12, allocations: 1.527 MB / 8.086 GB, free: 36.31 MB / 1.37 GB
Notification: Performance of postOpt simplifyTimeIndepFuncCalls (simulation): time 0.003436/27.12, allocations: 88.05 kB / 8.086 GB, free: 36.31 MB / 1.37 GB
Notification: Performance of postOpt simplifyAllExpressions (simulation): time 0.009198/27.13, allocations: 0.5991 MB / 8.087 GB, free: 36.29 MB / 1.37 GB
Notification: Performance of postOpt findZeroCrossings (simulation): time 0.001034/27.13, allocations: 254 kB / 8.087 GB, free: 36.29 MB / 1.37 GB
Notification: Performance of postOpt collapseArrayExpressions (simulation): time 0.001021/27.13, allocations: 172.8 kB / 8.087 GB, free: 36.29 MB / 1.37 GB
Notification: Performance of sorting global known variables: time 0.01504/27.15, allocations: 5.174 MB / 8.092 GB, free: 36.04 MB / 1.37 GB
Notification: Performance of sort global known variables: time 5.21e-07/27.15, allocations: 0 / 8.092 GB, free: 36.04 MB / 1.37 GB
Notification: Performance of remove unused functions: time 0.03102/27.18, allocations: 4.725 MB / 8.097 GB, free: 36.04 MB / 1.37 GB
Notification: Model statistics after passing the back-end for simulation:
 * Number of independent subsystems: 3
 * Number of states: 29 (vol.dynBal.medium.Xi[1],vol.dynBal.m,heaCap.T,rad.vol[1].dynBal.U,rad.vol[2].dynBal.U,rad.vol[3].dynBal.U,rad.vol[4].dynBal.U,rad.vol[5].dynBal.U,temSup.T,pumRad.vol.dynBal.U,pumRad.filter.s[1],pumRad.filter.s[2],mix.vol.dynBal.U,spl.vol.dynBal.U,spl2.vol.dynBal.U,mix2.vol.dynBal.U,spl4.vol.dynBal.U,pumBoi.vol.dynBal.U,pumBoi.filter.s[1],pumBoi.filter.s[2],boi.heaCapDry.T,valRad.vol.dynBal.U,valRad.filter.s[1],valRad.filter.s[2],valBoi.vol.dynBal.U,valBoi.filter.s[1],valBoi.filter.s[2],temRet.T,spl1.vol.dynBal.U)
 * Number of discrete variables: 8 ($whenCondition1,timTab.tab.nextTimeEvent,timTab.tab.nextTimeEventScaled,hysTOut.y,hysTBoi.y,and1.y,and2.y,hysPum.y)
 * Number of discrete states: 5 (timTab.tab.nextTimeEvent,hysTOut.y,hysTBoi.y,hysPum.y,timTab.tab.nextTimeEventScaled)
 * Number of clocked states: 0 ()
 * Top-level inputs: 0
Notification: Strong component statistics for simulation (346):
 * Single equations (assignments): 326
 * Array equations: 0
 * Algorithm blocks: 0
 * Record equations: 9
 * When equations: 2
 * If-equations: 0
 * Equation systems (linear and non-linear blocks): 1
 * Torn equation systems: 8
 * 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: Torn system details for strict tearing set:
 * Linear torn systems: 7 {(1,100.0%) 4,(1,100.0%) 3,(1,100.0%) 1,(1,100.0%) 1,(1,100.0%) 1,(1,100.0%) 1,(1,100.0%) 1}
 * Non-linear torn systems: 1 {13 22}
Notification: Performance of Backend phase and start with SimCode phase: time 0.03513/27.22, allocations: 13.46 MB / 8.11 GB, free: 32.55 MB / 1.37 GB
Notification: Performance of simCode: created initialization part: time 0.02563/27.24, allocations: 8.423 MB / 8.118 GB, free: 47.83 MB / 1.385 GB
Notification: Performance of simCode: created event and clocks part: time 2.199e-05/27.24, allocations: 9.688 kB / 8.118 GB, free: 47.82 MB / 1.385 GB
Notification: Performance of simCode: created simulation system equations: time 0.006611/27.25, allocations: 2.925 MB / 8.121 GB, free: 47.02 MB / 1.385 GB
Notification: Performance of simCode: created of all other equations (e.g. parameter, nominal, assert, etc): time 0.02504/27.27, allocations: 4.241 MB / 8.125 GB, free: 46.99 MB / 1.385 GB
Notification: Performance of simCode: created linear, non-linear and system jacobian parts: time 0.08599/27.36, allocations: 52.31 MB / 8.176 GB, free: 23.73 MB / 1.401 GB
Notification: Performance of simCode: some other stuff during SimCode phase: time 0.02089/27.38, allocations: 5.006 MB / 8.181 GB, free: 22.73 MB / 1.401 GB
Notification: Performance of simCode: alias equations: time 0.02115/27.4, allocations: 2.32 MB / 8.183 GB, free: 22.45 MB / 1.401 GB
Notification: Performance of simCode: all other stuff during SimCode phase: time 0.01175/27.41, allocations: 4.298 MB / 8.188 GB, free: 22.44 MB / 1.401 GB
Notification: Performance of SimCode: time 8.41e-07/27.41, allocations: 0 / 8.188 GB, free: 22.44 MB / 1.401 GB
Notification: Performance of buildModelFMU: Generate the FMI files: time 0.5311/27.94, allocations: 278.4 MB / 8.459 GB, free: 12.94 MB / 1.464 GB
Notification: Performance of buildModelFMU: configured platform static using cached values: time 0.0002162/27.94, allocations: 247.2 kB / 8.46 GB, free: 12.69 MB / 1.464 GB
Notification: Performance of buildModelFMU: Generate platform static: time 13.27/41.21, allocations: 0 / 8.46 GB, free: 12.69 MB / 1.464 GB
(rm -f Buildings_9_Buildings.Examples.Tutorial.Boiler.System4.pipe ; mkfifo Buildings_9_Buildings.Examples.Tutorial.Boiler.System4.pipe ; head -c 1048576 < Buildings_9_Buildings.Examples.Tutorial.Boiler.System4.pipe >> ../files/Buildings_9_Buildings.Examples.Tutorial.Boiler.System4.sim & /home/hudson/saved_omc/OMSimulator/install/linux/bin/OMSimulator -r=Buildings_9_Buildings.Examples.Tutorial.Boiler.System4_res.mat --tempDir=temp_Buildings_9_Buildings_Examples_Tutorial_Boiler_System4_fmu --startTime=0 --stopTime=172800 --timeout=50 --tolerance=1e-06 Buildings_9_Buildings_Examples_Tutorial_Boiler_System4.fmu > Buildings_9_Buildings.Examples.Tutorial.Boiler.System4.pipe 2>&1)
TODO: How the !@#!# did the simulation report success but simulation result Buildings_9_Buildings.Examples.Tutorial.Boiler.System4_res.mat does not exist to compare? outputFormat=mat