Running: ./testmodel.py --libraries=/home/hudson/saved_omc/libraries/.openmodelica/libraries/ --ompython_omhome=/usr Buildings_8_Buildings.Fluid.MixingVolumes.Validation.MixingVolume.conf.json
loadFile("/home/hudson/saved_omc/libraries/.openmodelica/libraries/Buildings 8.1.1-maint.8.1.x/package.mo", uses=false)
loadFile("/home/hudson/saved_omc/libraries/.openmodelica/libraries/Complex 3.2.3+maint.om/package.mo", uses=false)
loadFile("/home/hudson/saved_omc/libraries/.openmodelica/libraries/Modelica 3.2.3+maint.om/package.mo", uses=false)
loadFile("/home/hudson/saved_omc/libraries/.openmodelica/libraries/ModelicaServices 3.2.3+maint.om/package.mo", uses=false)
Using package ModelicaServices with version 3.2.3 (/home/hudson/saved_omc/libraries/.openmodelica/libraries/ModelicaServices 3.2.3+maint.om/package.mo)
Using package Modelica with version 3.2.3 (/home/hudson/saved_omc/libraries/.openmodelica/libraries/Modelica 3.2.3+maint.om/package.mo)
Using package Complex with version 3.2.3 (/home/hudson/saved_omc/libraries/.openmodelica/libraries/Complex 3.2.3+maint.om/package.mo)
Using package Buildings with version 8.1.1 (/home/hudson/saved_omc/libraries/.openmodelica/libraries/Buildings 8.1.1-maint.8.1.x/package.mo)
Running command: translateModel(Buildings.Fluid.MixingVolumes.Validation.MixingVolume,tolerance=1e-09,outputFormat="empty",numberOfIntervals=5000,variableFilter="",fileNamePrefix="Buildings_8_Buildings.Fluid.MixingVolumes.Validation.MixingVolume")
translateModel(Buildings.Fluid.MixingVolumes.Validation.MixingVolume,tolerance=1e-09,outputFormat="empty",numberOfIntervals=5000,variableFilter="",fileNamePrefix="Buildings_8_Buildings.Fluid.MixingVolumes.Validation.MixingVolume")
Notification: Performance of loadFile(/home/hudson/saved_omc/libraries/.openmodelica/libraries/Buildings 8.1.1-maint.8.1.x/package.mo): time 1.702/1.702, allocations: 293 MB / 309 MB, free: 4.797 MB / 234.7 MB
Notification: Performance of loadFile(/home/hudson/saved_omc/libraries/.openmodelica/libraries/Complex 3.2.3+maint.om/package.mo): time 0.0009788/0.0009788, allocations: 172.6 kB / 378.7 MB, free: 1.02 MB / 298.7 MB
Notification: Performance of loadFile(/home/hudson/saved_omc/libraries/.openmodelica/libraries/Modelica 3.2.3+maint.om/package.mo): time 1.571/1.571, allocations: 205.4 MB / 0.6383 GB, free: 8.129 MB / 474.7 MB
Notification: Performance of loadFile(/home/hudson/saved_omc/libraries/.openmodelica/libraries/ModelicaServices 3.2.3+maint.om/package.mo): time 0.0007723/0.0007725, allocations: 91.61 kB / 0.7527 GB, free: 62.92 MB / 0.5573 GB
Notification: Performance of FrontEnd - loaded program: time 0.0003796/0.0003797, allocations: 15.98 kB / 0.8768 GB, free: 10.41 MB / 0.6042 GB
Notification: Performance of FrontEnd - Absyn->SCode: time 0.242/0.2424, allocations: 116.4 MB / 0.9904 GB, free: 5.867 MB / 0.7136 GB
Notification: Performance of FrontEnd - scodeFlatten: time 5.377/5.62, allocations: 2.088 GB / 3.078 GB, free: 127.7 MB / 0.948 GB
Notification: Performance of FrontEnd - mkProgramGraph: time 0.0003771/5.62, allocations: 101.2 kB / 3.078 GB, free: 127.6 MB / 0.948 GB
Notification: Performance of FrontEnd - DAE generated: time 5.88/11.5, allocations: 1.336 GB / 4.414 GB, free: 110.3 MB / 0.9792 GB
Notification: Performance of FrontEnd: time 2.475e-06/11.5, allocations: 1.062 kB / 4.414 GB, free: 110.3 MB / 0.9792 GB
Notification: Performance of Transformations before backend: time 0.0003691/11.5, allocations: 56.03 kB / 4.414 GB, free: 110.3 MB / 0.9792 GB
Notification: Model statistics after passing the front-end and creating the data structures used by the back-end:
 * Number of equations: 363
 * Number of variables: 363
Notification: Performance of Generate backend data structure: time 0.01025/11.51, allocations: 2.451 MB / 4.417 GB, free: 109.3 MB / 0.9792 GB
Notification: Performance of prepare preOptimizeDAE: time 5.707e-05/11.51, allocations: 10 kB / 4.417 GB, free: 109.3 MB / 0.9792 GB
Notification: Performance of preOpt normalInlineFunction (simulation): time 0.004749/11.52, allocations: 0.5006 MB / 4.417 GB, free: 109.1 MB / 0.9792 GB
Notification: Performance of preOpt evaluateParameters (simulation): time 0.006937/11.52, allocations: 1.473 MB / 4.418 GB, free: 108.8 MB / 0.9792 GB
Notification: Performance of preOpt simplifyIfEquations (simulation): time 0.000491/11.52, allocations: 178.9 kB / 4.419 GB, free: 108.7 MB / 0.9792 GB
Notification: Performance of preOpt expandDerOperator (simulation): time 0.00116/11.52, allocations: 155.8 kB / 4.419 GB, free: 108.7 MB / 0.9792 GB
Notification: Performance of preOpt clockPartitioning (simulation): time 0.008266/11.53, allocations: 1.709 MB / 4.42 GB, free: 108.5 MB / 0.9792 GB
Notification: Performance of preOpt findStateOrder (simulation): time 0.0001489/11.53, allocations: 8.094 kB / 4.42 GB, free: 108.5 MB / 0.9792 GB
Notification: Performance of preOpt replaceEdgeChange (simulation): time 0.0005739/11.53, allocations: 63.19 kB / 4.421 GB, free: 108.5 MB / 0.9792 GB
Notification: Performance of preOpt inlineArrayEqn (simulation): time 0.0001717/11.53, allocations: 58.05 kB / 4.421 GB, free: 108.5 MB / 0.9792 GB
Notification: Performance of preOpt removeEqualRHS (simulation): time 0.004732/11.54, allocations: 1.339 MB / 4.422 GB, free: 108.4 MB / 0.9792 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.0148/11.55, allocations: 8.233 MB / 4.43 GB, free: 103.6 MB / 0.9792 GB
Notification: Performance of preOpt comSubExp (simulation): time 0.001513/11.55, allocations: 0.8967 MB / 4.431 GB, free: 103.6 MB / 0.9792 GB
Notification: Performance of preOpt resolveLoops (simulation): time 0.0009548/11.56, allocations: 0.5278 MB / 4.431 GB, free: 103.6 MB / 0.9792 GB
Notification: Performance of preOpt evalFunc (simulation): time 0.0005464/11.56, allocations: 321.1 kB / 4.432 GB, free: 103.3 MB / 0.9792 GB
Notification: Performance of preOpt encapsulateWhenConditions (simulation): time 5.07e-05/11.56, allocations: 52.61 kB / 4.432 GB, free: 103.2 MB / 0.9792 GB
Notification: Performance of pre-optimization done (n=96): time 5.249e-06/11.56, allocations: 0 / 4.432 GB, free: 103.2 MB / 0.9792 GB
Notification: Performance of matching and sorting (n=102): time 0.008777/11.56, allocations: 3.126 MB / 4.435 GB, free: 102.6 MB / 0.9792 GB
Notification: Performance of inlineWhenForInitialization (initialization): time 4.648e-05/11.57, allocations: 62.75 kB / 4.435 GB, free: 102.6 MB / 0.9792 GB
Notification: Performance of selectInitializationVariablesDAE (initialization): time 0.002433/11.57, allocations: 1.242 MB / 4.436 GB, free: 102.4 MB / 0.9792 GB
Notification: Performance of collectPreVariables (initialization): time 0.0001677/11.57, allocations: 52.23 kB / 4.436 GB, free: 102.4 MB / 0.9792 GB
Notification: Performance of collectInitialEqns (initialization): time 0.0006352/11.57, allocations: 0.8026 MB / 4.437 GB, free: 102.1 MB / 0.9792 GB
Notification: Performance of collectInitialBindings (initialization): time 0.0003808/11.57, allocations: 364.4 kB / 4.437 GB, free: 101.8 MB / 0.9792 GB
Notification: Performance of simplifyInitialFunctions (initialization): time 7.205e-05/11.57, allocations: 23.91 kB / 4.437 GB, free: 101.8 MB / 0.9792 GB
Notification: Performance of setup shared object (initialization): time 0.0001148/11.57, allocations: 359.2 kB / 4.438 GB, free: 101.5 MB / 0.9792 GB
Notification: Performance of preBalanceInitialSystem (initialization): time 0.0007956/11.57, allocations: 425.6 kB / 4.438 GB, free: 101.5 MB / 0.9792 GB
Notification: Performance of partitionIndependentBlocks (initialization): time 0.001019/11.57, allocations: 0.8375 MB / 4.439 GB, free: 101.1 MB / 0.9792 GB
Notification: Performance of analyzeInitialSystem (initialization): time 0.001825/11.57, allocations: 1.246 MB / 4.44 GB, free: 100.7 MB / 0.9792 GB
Notification: Performance of solveInitialSystemEqSystem (initialization): time 2.025e-05/11.57, allocations: 3.375 kB / 4.44 GB, free: 100.7 MB / 0.9792 GB
Notification: Performance of matching and sorting (n=150) (initialization): time 0.002711/11.58, allocations: 1.395 MB / 4.441 GB, free: 100.6 MB / 0.9792 GB
Notification: Performance of prepare postOptimizeDAE: time 0.0002414/11.58, allocations: 368.3 kB / 4.442 GB, free: 100.2 MB / 0.9792 GB
Notification: Performance of postOpt simplifyComplexFunction (initialization): time 2.005e-05/11.58, allocations: 7.438 kB / 4.442 GB, free: 100.2 MB / 0.9792 GB
Notification: Performance of postOpt tearingSystem (initialization): time 4.136e-05/11.58, allocations: 15.38 kB / 4.442 GB, free: 100.2 MB / 0.9792 GB
Notification: Performance of postOpt solveSimpleEquations (initialization): time 0.001119/11.58, allocations: 285.8 kB / 4.442 GB, free: 100.2 MB / 0.9792 GB
Notification: Performance of postOpt calculateStrongComponentJacobians (initialization): time 4.072e-05/11.58, allocations: 19.34 kB / 4.442 GB, free: 100.2 MB / 0.9792 GB
Notification: Performance of postOpt simplifyAllExpressions (initialization): time 0.002206/11.58, allocations: 173 kB / 4.442 GB, free: 100.2 MB / 0.9792 GB
Notification: Performance of postOpt collapseArrayExpressions (initialization): time 0.0001443/11.58, allocations: 58.31 kB / 4.442 GB, free: 100.2 MB / 0.9792 GB
Notification: Performance of prepare postOptimizeDAE: time 9.568e-06/11.58, allocations: 3.031 kB / 4.442 GB, free: 100.2 MB / 0.9792 GB
Notification: Performance of postOpt replaceHomotopyWithSimplified (initialization): time 0.002144/11.58, allocations: 1.223 MB / 4.443 GB, free: 100.2 MB / 0.9792 GB
Notification: Performance of postOpt simplifyComplexFunction (initialization): time 2.239e-05/11.58, allocations: 9.312 kB / 4.443 GB, free: 100.2 MB / 0.9792 GB
Notification: Performance of postOpt tearingSystem (initialization): time 2.179e-05/11.58, allocations: 16.52 kB / 4.443 GB, free: 100.2 MB / 0.9792 GB
Notification: Performance of postOpt solveSimpleEquations (initialization): time 0.00102/11.58, allocations: 282.5 kB / 4.444 GB, free: 100.2 MB / 0.9792 GB
Notification: Performance of postOpt calculateStrongComponentJacobians (initialization): time 3.184e-05/11.58, allocations: 23.78 kB / 4.444 GB, free: 100.2 MB / 0.9792 GB
Notification: Performance of postOpt simplifyAllExpressions (initialization): time 0.002248/11.58, allocations: 172.9 kB / 4.444 GB, free: 100.1 MB / 0.9792 GB
Notification: Performance of postOpt collapseArrayExpressions (initialization): time 0.0001515/11.58, allocations: 52.97 kB / 4.444 GB, free: 100.1 MB / 0.9792 GB
Notification: Model statistics after passing the back-end for initialization:
 * Number of independent subsystems: 41
 * Number of states: 0 ()
 * Number of discrete variables: 4 (vol.regularFlow[1],vol.regularFlow[2],vol.inFlow[2],vol.inFlow[1])
 * Number of discrete states: 0 ()
 * Number of clocked states: 0 ()
 * Top-level inputs: 0
Notification: Strong component statistics for initialization (150):
 * Single equations (assignments): 150
 * 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.001456/11.59, allocations: 0.5133 MB / 4.444 GB, free: 99.94 MB / 0.9792 GB
Notification: Performance of postOpt lateInlineFunction (simulation): time 0.000637/11.59, allocations: 170.9 kB / 4.445 GB, free: 99.86 MB / 0.9792 GB
Notification: Performance of postOpt wrapFunctionCalls (simulation): time 0.00255/11.59, allocations: 1.154 MB / 4.446 GB, free: 99.77 MB / 0.9792 GB
Notification: Performance of postOpt inlineArrayEqn (simulation): time 1.165e-05/11.59, allocations: 11.72 kB / 4.446 GB, free: 99.77 MB / 0.9792 GB
Notification: Performance of postOpt constantLinearSystem (simulation): time 9.478e-06/11.59, allocations: 0 / 4.446 GB, free: 99.77 MB / 0.9792 GB
Notification: Performance of postOpt simplifysemiLinear (simulation): time 0.001572/11.59, allocations: 1.086 MB / 4.447 GB, free: 99.5 MB / 0.9792 GB
Notification: Performance of postOpt removeSimpleEquations (simulation): time 0.006846/11.6, allocations: 2.779 MB / 4.45 GB, free: 99.1 MB / 0.9792 GB
Notification: Performance of postOpt simplifyComplexFunction (simulation): time 9.088e-06/11.6, allocations: 4.062 kB / 4.45 GB, free: 99.1 MB / 0.9792 GB
Notification: Performance of postOpt solveSimpleEquations (simulation): time 0.001177/11.6, allocations: 250.4 kB / 4.45 GB, free: 99.1 MB / 0.9792 GB
Notification: Performance of postOpt tearingSystem (simulation): time 2.852e-05/11.6, allocations: 7.25 kB / 4.45 GB, free: 99.1 MB / 0.9792 GB
Notification: Performance of postOpt inputDerivativesUsed (simulation): time 0.0001055/11.6, allocations: 32.44 kB / 4.45 GB, free: 99.09 MB / 0.9792 GB
Notification: Performance of postOpt calculateStrongComponentJacobians (simulation): time 1.351e-05/11.6, allocations: 9.969 kB / 4.45 GB, free: 99.09 MB / 0.9792 GB
Notification: Performance of postOpt calculateStateSetsJacobians (simulation): time 4.448e-06/11.6, allocations: 6.312 kB / 4.45 GB, free: 99.09 MB / 0.9792 GB
Notification: Performance of postOpt symbolicJacobian (simulation): time 0.003205/11.6, allocations: 1.809 MB / 4.452 GB, free: 98.79 MB / 0.9792 GB
Notification: Performance of postOpt removeConstants (simulation): time 0.001262/11.6, allocations: 337.4 kB / 4.452 GB, free: 98.61 MB / 0.9792 GB
Notification: Performance of postOpt simplifyTimeIndepFuncCalls (simulation): time 0.0006116/11.6, allocations: 26.5 kB / 4.452 GB, free: 98.61 MB / 0.9792 GB
Notification: Performance of postOpt simplifyAllExpressions (simulation): time 0.001902/11.61, allocations: 157.1 kB / 4.452 GB, free: 98.59 MB / 0.9792 GB
Notification: Performance of postOpt findZeroCrossings (simulation): time 0.0001669/11.61, allocations: 61.8 kB / 4.452 GB, free: 98.59 MB / 0.9792 GB
Notification: Performance of postOpt collapseArrayExpressions (simulation): time 0.0001067/11.61, allocations: 35.48 kB / 4.452 GB, free: 98.59 MB / 0.9792 GB
Notification: Performance of sorting global known variables: time 0.001853/11.61, allocations: 0.8254 MB / 4.453 GB, free: 98.48 MB / 0.9792 GB
Notification: Performance of sort global known variables: time 2.51e-07/11.61, allocations: 0 / 4.453 GB, free: 98.48 MB / 0.9792 GB
Notification: Performance of remove unused functions: time 0.005231/11.61, allocations: 1.076 MB / 4.454 GB, free: 98.46 MB / 0.9792 GB
Notification: Model statistics after passing the back-end for simulation:
 * Number of independent subsystems: 8
 * Number of states: 9 (vol1.dynBal.U,vol1.dynBal.m,vol1.dynBal.mXi[1],vol.medium.Xi[1],vol.medium.T,vol.m,vol2.dynBal.U,vol2.dynBal.m,vol2.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 (102):
 * Single equations (assignments): 102
 * 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 Backend phase and start with SimCode phase: time 0.005544/11.62, allocations: 3.034 MB / 4.457 GB, free: 97.19 MB / 0.9792 GB
Notification: Performance of simCode: created initialization part: time 0.003995/11.62, allocations: 1.735 MB / 4.459 GB, free: 97.16 MB / 0.9792 GB
Notification: Performance of simCode: created event and clocks part: time 9.107e-06/11.62, allocations: 3.906 kB / 4.459 GB, free: 97.16 MB / 0.9792 GB
Notification: Performance of simCode: created simulation system equations: time 0.001015/11.62, allocations: 0.5164 MB / 4.459 GB, free: 97.16 MB / 0.9792 GB
Notification: Performance of simCode: created of all other equations (e.g. parameter, nominal, assert, etc): time 0.006579/11.63, allocations: 0.9539 MB / 4.46 GB, free: 97.12 MB / 0.9792 GB
Notification: Performance of simCode: created linear, non-linear and system jacobian parts: time 0.00804/11.64, allocations: 4.236 MB / 4.464 GB, free: 95.4 MB / 0.9792 GB
Notification: Performance of simCode: some other stuff during SimCode phase: time 0.001614/11.64, allocations: 1.445 MB / 4.466 GB, free: 94.67 MB / 0.9792 GB
Notification: Performance of simCode: alias equations: time 0.003086/11.64, allocations: 0.5582 MB / 4.466 GB, free: 94.65 MB / 0.9792 GB
Notification: Performance of simCode: all other stuff during SimCode phase: time 0.0006437/11.64, allocations: 132.5 kB / 4.466 GB, free: 94.64 MB / 0.9792 GB
Notification: Performance of SimCode: time 1.493e-06/11.64, allocations: 0 / 4.466 GB, free: 94.64 MB / 0.9792 GB
Notification: Performance of Templates: time 0.1045/11.75, allocations: 62.57 MB / 4.527 GB, free: 91.08 MB / 0.9792 GB
make -j1 -f Buildings_8_Buildings.Fluid.MixingVolumes.Validation.MixingVolume.makefile
(rm -f Buildings_8_Buildings.Fluid.MixingVolumes.Validation.MixingVolume.pipe ; mkfifo Buildings_8_Buildings.Fluid.MixingVolumes.Validation.MixingVolume.pipe ; head -c 1048576 < Buildings_8_Buildings.Fluid.MixingVolumes.Validation.MixingVolume.pipe >> ../files/Buildings_8_Buildings.Fluid.MixingVolumes.Validation.MixingVolume.sim & ./Buildings_8_Buildings.Fluid.MixingVolumes.Validation.MixingVolume -abortSlowSimulation -alarm=480 -lv LOG_STATS > Buildings_8_Buildings.Fluid.MixingVolumes.Validation.MixingVolume.pipe 2>&1)