Running: ./testmodel.py --libraries=/home/hudson/saved_omc/libraries/.openmodelica/libraries --ompython_omhome=/usr Buildings_12_Buildings.Examples.ChillerPlant.DataCenterRenewables.conf.json
loadFile("/home/hudson/saved_omc/libraries/.openmodelica/libraries/ModelicaServices 4.1.0+maint.om/package.mo", uses=false) [Timeout 180]
"Notification: Performance of loadFile(/home/hudson/saved_omc/libraries/.openmodelica/libraries/ModelicaServices 4.1.0+maint.om/package.mo): time 0.0008294/0.0008294, allocations: 80.44 kB / 19.17 MB, free: 0.7422 MB / 13.93 MB
"
[Timeout remaining time 180]
loadFile("/home/hudson/saved_omc/libraries/.openmodelica/libraries/Complex 4.1.0+maint.om/package.mo", uses=false) [Timeout 180]
"Notification: Performance of loadFile(/home/hudson/saved_omc/libraries/.openmodelica/libraries/Complex 4.1.0+maint.om/package.mo): time 0.0008546/0.0008546, allocations: 169.9 kB / 22.46 MB, free: 2.105 MB / 18.57 MB
"
[Timeout remaining time 180]
loadFile("/home/hudson/saved_omc/libraries/.openmodelica/libraries/Modelica 4.1.0+maint.om/package.mo", uses=false) [Timeout 180]
"Notification: Performance of loadFile(/home/hudson/saved_omc/libraries/.openmodelica/libraries/Modelica 4.1.0+maint.om/package.mo): time 0.9022/0.9022, allocations: 177.1 MB / 202.8 MB, free: 5.738 MB / 186.7 MB
"
[Timeout remaining time 179]
loadFile("/home/hudson/saved_omc/libraries/.openmodelica/libraries/Buildings 12.1.2-maint.12.x/package.mo", uses=false) [Timeout 180]
"Notification: Performance of loadFile(/home/hudson/saved_omc/libraries/.openmodelica/libraries/Buildings 12.1.2-maint.12.x/package.mo): time 1.751/1.751, allocations: 377.8 MB / 0.6221 GB, free: 8.684 MB / 0.5886 GB
"
[Timeout remaining time 178]
Using package Buildings with version 12.1.2 (/home/hudson/saved_omc/libraries/.openmodelica/libraries/Buildings 12.1.2-maint.12.x/package.mo)
Using package Modelica with version 4.1.0 (/home/hudson/saved_omc/libraries/.openmodelica/libraries/Modelica 4.1.0+maint.om/package.mo)
Using package Complex with version 4.1.0 (/home/hudson/saved_omc/libraries/.openmodelica/libraries/Complex 4.1.0+maint.om/package.mo)
Using package ModelicaServices with version 4.1.0 (/home/hudson/saved_omc/libraries/.openmodelica/libraries/ModelicaServices 4.1.0+maint.om/package.mo)
Running command: "" <> buildModelFMU(Buildings.Examples.ChillerPlant.DataCenterRenewables,fileNamePrefix="Buildings_12_Buildings_Examples_ChillerPlant_DataCenterRenewables",fmuType="me",version="2.0",platforms={"static"})
"" <> buildModelFMU(Buildings.Examples.ChillerPlant.DataCenterRenewables,fileNamePrefix="Buildings_12_Buildings_Examples_ChillerPlant_DataCenterRenewables",fmuType="me",version="2.0",platforms={"static"}) [Timeout 300]
"Notification: Performance of FrontEnd - loaded program: time 1.833e-06/1.833e-06, allocations: 0 / 0.9809 GB, free: 2.668 MB / 0.9323 GB
Notification: Performance of FrontEnd - Absyn->SCode: time 2.28e-05/2.464e-05, allocations: 2.281 kB / 0.9809 GB, free: 2.664 MB / 0.9323 GB
Notification: Performance of NFInst.instantiate(Buildings.Examples.ChillerPlant.DataCenterRenewables): time 0.8446/0.8446, allocations: 436.8 MB / 1.407 GB, free: 5.082 MB / 1.229 GB
Notification: Performance of NFInst.instExpressions: time 0.09015/0.9347, allocations: 74.73 MB / 1.48 GB, free: 10.18 MB / 1.307 GB
Notification: Performance of NFInst.updateImplicitVariability: time 0.01426/0.949, allocations: 0.527 MB / 1.481 GB, free: 9.652 MB / 1.307 GB
Notification: Performance of NFTyping.typeComponents: time 0.01734/0.9663, allocations: 7.173 MB / 1.488 GB, free: 2.453 MB / 1.307 GB
Notification: Performance of NFTyping.typeBindings: time 0.03459/1.001, allocations: 16.7 MB / 1.504 GB, free: 1.688 MB / 1.323 GB
Notification: Performance of NFTyping.typeClassSections: time 0.02083/1.022, allocations: 12.48 MB / 1.516 GB, free: 5.27 MB / 1.339 GB
Notification: Performance of NFFlatten.flatten: time 1.239/2.261, allocations: 53.81 MB / 1.569 GB, free: 64.84 MB / 1.386 GB
Notification: Performance of NFFlatten.resolveConnections: time 0.03833/2.3, allocations: 23.33 MB / 1.592 GB, free: 63.94 MB / 1.386 GB
Notification: Performance of NFEvalConstants.evaluate: time 0.05601/2.356, allocations: 23.87 MB / 1.615 GB, free: 63.93 MB / 1.386 GB
Notification: Performance of NFSimplifyModel.simplify: time 0.02615/2.382, allocations: 11.45 MB / 1.626 GB, free: 63.91 MB / 1.386 GB
Notification: Performance of NFPackage.collectConstants: time 0.008064/2.39, allocations: 2.204 MB / 1.628 GB, free: 63.91 MB / 1.386 GB
Notification: Performance of NFFlatten.collectFunctions: time 0.02396/2.414, allocations: 9.211 MB / 1.637 GB, free: 63.91 MB / 1.386 GB
Notification: Performance of NFScalarize.scalarize: time 0.01317/2.427, allocations: 6.188 MB / 1.643 GB, free: 63.91 MB / 1.386 GB
Notification: Performance of NFVerifyModel.verify: time 0.01876/2.446, allocations: 7.146 MB / 1.65 GB, free: 63.91 MB / 1.386 GB
Notification: Performance of NFConvertDAE.convert: time 0.04862/2.494, allocations: 36.4 MB / 1.686 GB, free: 61.98 MB / 1.386 GB
Notification: Performance of FrontEnd - DAE generated: time 7.955e-06/2.494, allocations: 3.938 kB / 1.686 GB, free: 61.97 MB / 1.386 GB
Notification: Performance of FrontEnd: time 1.933e-06/2.494, allocations: 0.9375 kB / 1.686 GB, free: 61.97 MB / 1.386 GB
Notification: Performance of Transformations before backend: time 0.001027/2.495, allocations: 0 / 1.686 GB, free: 61.97 MB / 1.386 GB
Notification: Model statistics after passing the front-end and creating the data structures used by the back-end:
 * Number of equations: 2819
 * Number of variables: 2819
Notification: Performance of Generate backend data structure: time 0.04957/2.545, allocations: 19.94 MB / 1.705 GB, free: 53.77 MB / 1.386 GB
Notification: Performance of prepare preOptimizeDAE: time 5.174e-05/2.545, allocations: 9.281 kB / 1.705 GB, free: 53.77 MB / 1.386 GB
Notification: Performance of preOpt introduceOutputAliases (simulation): time 0.006075/2.551, allocations: 1.445 MB / 1.707 GB, free: 53.66 MB / 1.386 GB
Notification: Performance of preOpt normalInlineFunction (simulation): time 0.02091/2.572, allocations: 5.005 MB / 1.712 GB, free: 52.62 MB / 1.386 GB
Notification: Performance of preOpt evaluateParameters (simulation): time 0.03191/2.604, allocations: 19.97 MB / 1.731 GB, free: 49.27 MB / 1.386 GB
Notification: Performance of preOpt simplifyIfEquations (simulation): time 0.0008272/2.605, allocations: 1.008 MB / 1.732 GB, free: 49.09 MB / 1.386 GB
Notification: Performance of preOpt expandDerOperator (simulation): time 0.004173/2.609, allocations: 1.137 MB / 1.733 GB, free: 49.08 MB / 1.386 GB
Notification: Performance of preOpt clockPartitioning (simulation): time 0.03194/2.641, allocations: 17.71 MB / 1.751 GB, free: 42.46 MB / 1.386 GB
Notification: Performance of preOpt findStateOrder (simulation): time 0.0002854/2.641, allocations: 22.55 kB / 1.751 GB, free: 42.46 MB / 1.386 GB
Notification: Performance of preOpt replaceEdgeChange (simulation): time 0.001236/2.642, allocations: 465 kB / 1.751 GB, free: 42.46 MB / 1.386 GB
Notification: Performance of preOpt inlineArrayEqn (simulation): time 0.0003204/2.643, allocations: 0.4946 MB / 1.752 GB, free: 42.41 MB / 1.386 GB
Notification: Performance of preOpt removeEqualRHS (simulation): time 0.0215/2.664, allocations: 14.97 MB / 1.766 GB, free: 38.16 MB / 1.386 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.06072/2.725, allocations: 51.5 MB / 1.817 GB, free: 1.773 MB / 1.386 GB
Notification: Performance of preOpt comSubExp (simulation): time 0.01501/2.74, allocations: 10.42 MB / 1.827 GB, free: 7.785 MB / 1.401 GB
Notification: Performance of preOpt resolveLoops (simulation): time 0.007755/2.748, allocations: 5.266 MB / 1.832 GB, free: 2.5 MB / 1.401 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.02685/2.774, allocations: 15.55 MB / 1.847 GB, free: 3.141 MB / 1.417 GB
Notification: Performance of preOpt encapsulateWhenConditions (simulation): time 0.007947/2.782, allocations: 7.268 MB / 1.854 GB, free: 11.44 MB / 1.432 GB
Notification: Performance of preOpt simplifyInStream (simulation): time 0.004705/2.787, allocations: 0.9547 MB / 1.855 GB, free: 10.49 MB / 1.432 GB
Notification: Performance of pre-optimization done (n=751): time 2.725e-05/2.787, allocations: 0 / 1.855 GB, free: 10.49 MB / 1.432 GB
Notification: Performance of matching and sorting (n=854): time 0.156/2.943, allocations: 63.4 MB / 1.917 GB, free: 11.07 MB / 1.495 GB
Notification: Performance of inlineWhenForInitialization (initialization): time 0.0001831/2.943, allocations: 397.4 kB / 1.917 GB, free: 10.62 MB / 1.495 GB
Notification: Performance of selectInitializationVariablesDAE (initialization): time 0.02202/2.965, allocations: 13.04 MB / 1.93 GB, free: 13.62 MB / 1.511 GB
Notification: Performance of collectPreVariables (initialization): time 0.002709/2.968, allocations: 243.2 kB / 1.93 GB, free: 13.38 MB / 1.511 GB
Notification: Performance of collectInitialEqns (initialization): time 0.007947/2.976, allocations: 7.221 MB / 1.937 GB, free: 6.168 MB / 1.511 GB
Notification: Performance of collectInitialBindings (initialization): time 0.004546/2.981, allocations: 2.936 MB / 1.94 GB, free: 3.277 MB / 1.511 GB
Notification: Performance of simplifyInitialFunctions (initialization): time 0.005918/2.986, allocations: 2.051 MB / 1.942 GB, free: 1.223 MB / 1.511 GB
Notification: Performance of setup shared object (initialization): time 7.211e-05/2.987, allocations: 305.1 kB / 1.943 GB, free: 0.9219 MB / 1.511 GB
Notification: Performance of preBalanceInitialSystem (initialization): time 0.01279/2.999, allocations: 7.032 MB / 1.949 GB, free: 9.871 MB / 1.526 GB
Notification: Performance of partitionIndependentBlocks (initialization): time 0.01704/3.016, allocations: 11.05 MB / 1.96 GB, free: 13.53 MB / 1.542 GB
Notification: Performance of analyzeInitialSystem (initialization): time 0.02779/3.044, allocations: 15.84 MB / 1.976 GB, free: 13.07 MB / 1.557 GB
Notification: Performance of solveInitialSystemEqSystem (initialization): time 5.537e-05/3.044, allocations: 16 kB / 1.976 GB, free: 13.06 MB / 1.557 GB
Notification: Performance of matching and sorting (n=1285) (initialization): time 0.03822/3.082, allocations: 18.48 MB / 1.994 GB, free: 10.82 MB / 1.573 GB
Notification: Performance of prepare postOptimizeDAE: time 4.813e-05/3.082, allocations: 28 kB / 1.994 GB, free: 10.8 MB / 1.573 GB
Notification: Performance of postOpt simplifyComplexFunction (initialization): time 6.819e-05/3.083, allocations: 56.05 kB / 1.994 GB, free: 10.74 MB / 1.573 GB
Notification: Performance of postOpt tearingSystem (initialization): time 0.001921/3.084, allocations: 0.8417 MB / 1.995 GB, free: 9.883 MB / 1.573 GB
Notification: Performance of postOpt solveSimpleEquations (initialization): time 0.01003/3.094, allocations: 2.835 MB / 1.997 GB, free: 7.18 MB / 1.573 GB
Notification: Performance of postOpt calculateStrongComponentJacobians (initialization): time 0.006699/3.101, allocations: 11.05 MB / 2.008 GB, free: 11.59 MB / 1.589 GB
Notification: Performance of postOpt simplifyAllExpressions (initialization): time 0.01287/3.114, allocations: 1.276 MB / 2.009 GB, free: 10.32 MB / 1.589 GB
Notification: Performance of postOpt collapseArrayExpressions (initialization): time 0.002708/3.117, allocations: 479.7 kB / 2.01 GB, free: 9.848 MB / 1.589 GB
Notification: Performance of preBalanceInitialSystem (initialization_lambda0): time 0.022/3.139, allocations: 11.18 MB / 2.021 GB, free: 14.66 MB / 1.604 GB
Notification: Performance of partitionIndependentBlocks (initialization_lambda0): time 0.01682/3.156, allocations: 10.99 MB / 2.032 GB, free: 2.379 MB / 1.604 GB
Notification: Performance of analyzeInitialSystem (initialization_lambda0): time 0.02842/3.184, allocations: 15.71 MB / 2.047 GB, free: 2.055 MB / 1.62 GB
Notification: Performance of solveInitialSystemEqSystem (initialization_lambda0): time 6.534e-05/3.184, allocations: 16 kB / 2.047 GB, free: 2.039 MB / 1.62 GB
Notification: Performance of matching and sorting (n=1285) (initialization_lambda0): time 0.04061/3.225, allocations: 18.26 MB / 2.065 GB, free: 16 kB / 1.636 GB
Notification: Performance of prepare postOptimizeDAE: time 5.529e-05/3.225, allocations: 30.39 kB / 2.065 GB, free: 15.98 MB / 1.651 GB
Notification: Performance of postOpt simplifyComplexFunction (initialization): time 6.68e-05/3.225, allocations: 56 kB / 2.065 GB, free: 15.93 MB / 1.651 GB
Notification: Performance of postOpt tearingSystem (initialization): time 0.001656/3.226, allocations: 0.7687 MB / 2.066 GB, free: 15.14 MB / 1.651 GB
Notification: Performance of postOpt solveSimpleEquations (initialization): time 0.009753/3.236, allocations: 2.803 MB / 2.068 GB, free: 12.47 MB / 1.651 GB
Notification: Performance of postOpt calculateStrongComponentJacobians (initialization): time 0.008798/3.245, allocations: 12.59 MB / 2.081 GB, free: 15.21 MB / 1.667 GB
Notification: Performance of postOpt simplifyAllExpressions (initialization): time 0.01406/3.259, allocations: 1.329 MB / 2.082 GB, free: 13.89 MB / 1.667 GB
Notification: Performance of postOpt collapseArrayExpressions (initialization): time 0.002842/3.262, allocations: 467.8 kB / 2.082 GB, free: 13.43 MB / 1.667 GB
Notification: Model statistics after passing the back-end for initialization:
 * Number of independent subsystems: 255
 * Number of states: 0 ()
 * Number of discrete variables: 138 ($PRE.dataCenterContinuousTimeControl.wseCon.T1.enableFire,$PRE.dataCenterContinuousTimeControl.wseCon.T2.enableFire,$PRE.con.multiSwitch1.u[1],$PRE.con.multiSwitch1.u[2],$PRE.con.t1.enableFire,$PRE.con.t2.enableFire,$PRE.con.t3.enableFire,$PRE.con.t4.enableFire,con.t4.t_start,$PRE.con.t4.t_start,con.t3.t_start,$PRE.con.t3.t_start,con.stateGraphRoot.resume,con.stateGraphRoot.suspend,dataCenterContinuousTimeControl.wseCon.stateGraphRoot.resume,dataCenterContinuousTimeControl.wseCon.stateGraphRoot.suspend,dataCenterContinuousTimeControl.chi.tru.y,con.t4.enableFire,con.t4.localCondition,con.t3.enableFire,con.t3.localCondition,con.discharge.active,con.discharge.oldActive,$PRE.con.discharge.oldActive,con.discharge.newActive,$PRE.con.discharge.newActive,con.discharge.localActive,$PRE.con.discharge.localActive,con.charge.active,con.charge.oldActive,$PRE.con.charge.oldActive,con.charge.newActive,$PRE.con.charge.newActive,con.charge.localActive,$PRE.con.charge.localActive,con.t2.t_start,$PRE.con.t2.t_start,con.t2.fire,con.t2.enableFire,con.t2.localCondition,con.t1.t_start,$PRE.con.t1.t_start,con.t1.fire,con.t1.enableFire,con.t1.localCondition,con.alternative.split[2].available,con.stateGraphRoot.activeSteps,con.off.oldActive,$PRE.con.off.oldActive,con.off.newActive,$PRE.con.off.newActive,con.off.outPort[1].reset,con.off.inPort[1].set,con.off.localActive,$PRE.con.off.localActive,con.off.active,con.multiSwitch1.firstActiveIndex,con.multiSwitch1.u[2],con.multiSwitch1.u[1],con.greaterThreshold.y,con.not1.y,con.lessThreshold.y,bat.cha.overCharged,$PRE.bat.cha.overCharged,bat.cha.underCharged,$PRE.bat.cha.underCharged,pv.HDirTil.incAng.decAng.k,$PRE.pv.HDirTil.incAng.decAng.k,pv.HDirTil.incAng.decAng.tNext,$PRE.pv.HDirTil.incAng.decAng.tNext,pv.HDifTil.incAng.decAng.k,$PRE.pv.HDifTil.incAng.decAng.k,pv.HDifTil.incAng.decAng.tNext,$PRE.pv.HDifTil.incAng.decAng.tNext,dataCenterContinuousTimeControl.or1.y,dataCenterContinuousTimeControl.or1.u1,dataCenterContinuousTimeControl.weaData.decAng.k,$PRE.dataCenterContinuousTimeControl.weaData.decAng.k,dataCenterContinuousTimeControl.weaData.decAng.tNext,$PRE.dataCenterContinuousTimeControl.weaData.decAng.tNext,dataCenterContinuousTimeControl.weaData.eqnTim.k,$PRE.dataCenterContinuousTimeControl.weaData.eqnTim.k,dataCenterContinuousTimeControl.weaData.eqnTim.tNext,$PRE.dataCenterContinuousTimeControl.weaData.eqnTim.tNext,dataCenterContinuousTimeControl.weaData.conTim.k,$PRE.dataCenterContinuousTimeControl.weaData.conTim.k,dataCenterContinuousTimeControl.weaData.conTim.tNext,$PRE.dataCenterContinuousTimeControl.weaData.conTim.tNext,dataCenterContinuousTimeControl.weaData.conTimMin.k,$PRE.dataCenterContinuousTimeControl.weaData.conTimMin.k,dataCenterContinuousTimeControl.weaData.conTimMin.tNext,$PRE.dataCenterContinuousTimeControl.weaData.conTimMin.tNext,dataCenterContinuousTimeControl.weaData.locTim.k,$PRE.dataCenterContinuousTimeControl.weaData.locTim.k,dataCenterContinuousTimeControl.weaData.locTim.tNext,$PRE.dataCenterContinuousTimeControl.weaData.locTim.tNext,dataCenterContinuousTimeControl.chiSwi.hysteresis.y,$PRE.dataCenterContinuousTimeControl.chiSwi.hysteresis.y,dataCenterContinuousTimeControl.wseCon.stateGraphRoot.activeSteps,dataCenterContinuousTimeControl.wseCon.T2.t_start,$PRE.dataCenterContinuousTimeControl.wseCon.T2.t_start,dataCenterContinuousTimeControl.wseCon.T2.fire,dataCenterContinuousTimeControl.wseCon.T2.enableFire,dataCenterContinuousTimeControl.wseCon.T2.localCondition,dataCenterContinuousTimeControl.wseCon.on.oldActive,$PRE.dataCenterContinuousTimeControl.wseCon.on.oldActive,dataCenterContinuousTimeControl.wseCon.on.newActive,$PRE.dataCenterContinuousTimeControl.wseCon.on.newActive,dataCenterContinuousTimeControl.wseCon.on.localActive,$PRE.dataCenterContinuousTimeControl.wseCon.on.localActive,dataCenterContinuousTimeControl.wseCon.on.active,dataCenterContinuousTimeControl.wseCon.T1.t_start,$PRE.dataCenterContinuousTimeControl.wseCon.T1.t_start,dataCenterContinuousTimeControl.wseCon.T1.fire,dataCenterContinuousTimeControl.wseCon.T1.enableFire,dataCenterContinuousTimeControl.wseCon.T1.localCondition,dataCenterContinuousTimeControl.wseCon.off.active,dataCenterContinuousTimeControl.wseCon.off.oldActive,$PRE.dataCenterContinuousTimeControl.wseCon.off.oldActive,dataCenterContinuousTimeControl.wseCon.off.newActive,$PRE.dataCenterContinuousTimeControl.wseCon.off.newActive,dataCenterContinuousTimeControl.wseCon.off.localActive,$PRE.dataCenterContinuousTimeControl.wseCon.off.localActive,$whenCondition1,$whenCondition2,$whenCondition3,$whenCondition4,$whenCondition5,$whenCondition6,$whenCondition7,$whenCondition8,$whenCondition9,$whenCondition10,$whenCondition11,$whenCondition12,dataCenterContinuousTimeControl.triAndRes.conPID.I.trigger_internal,dataCenterContinuousTimeControl.EIT.local_reset,dataCenterContinuousTimeControl.EHVAC.local_reset)
 * Number of discrete states: 0 ()
 * Number of clocked states: 0 ()
 * Top-level inputs: 0
Notification: Strong component statistics for initialization (1238):
 * Single equations (assignments): 1219
 * Array equations: 8
 * Algorithm blocks: 0
 * Record equations: 0
 * When equations: 0
 * If-equations: 0
 * Equation systems (not torn): 2
 * Torn equation systems: 9
 * Mixed (continuous/discrete) equation systems: 0
Notification: Equation system details (not torn):
 * Constant Jacobian (size): 0 systems
 * Linear Jacobian (size,density): 0 systems
 * Non-linear Jacobian (size): 2 systems
   {1, 1}
 * Without analytic Jacobian (size): 0 systems
Notification: Torn system details for strict tearing set:
 * Linear torn systems (#iteration vars, #inner vars, density): 3 systems
   {(1,7,100.0%), (1,1,100.0%), (1,1,100.0%)}
 * Non-linear torn systems (#iteration vars, #inner vars): 6 systems
   {(3,9), (1,2), (2,9), (1,1), (1,1), (1,2)}
Notification: Performance of prepare postOptimizeDAE: time 0.003764/3.266, allocations: 0.8551 MB / 2.083 GB, free: 12.69 MB / 1.667 GB
Notification: Performance of postOpt lateInlineFunction (simulation): time 0.005352/3.271, allocations: 1.417 MB / 2.085 GB, free: 11.27 MB / 1.667 GB
Notification: Performance of postOpt wrapFunctionCalls (simulation): time 0.03999/3.311, allocations: 17.38 MB / 2.102 GB, free: 9.918 MB / 1.682 GB
Notification: Performance of postOpt inlineArrayEqn (simulation): time 7.609e-05/3.311, allocations: 99.98 kB / 2.102 GB, free: 9.82 MB / 1.682 GB
Notification: Performance of postOpt constantLinearSystem (simulation): time 1.952e-05/3.311, allocations: 4 kB / 2.102 GB, free: 9.816 MB / 1.682 GB
Notification: Performance of postOpt simplifysemiLinear (simulation): time 0.0343/3.345, allocations: 14.32 MB / 2.116 GB, free: 11.44 MB / 1.698 GB
Notification: Performance of postOpt removeSimpleEquations (simulation): time 0.07302/3.418, allocations: 40.67 MB / 2.155 GB, free: 1.566 MB / 1.729 GB
Notification: Performance of postOpt simplifyComplexFunction (simulation): time 3.285e-05/3.418, allocations: 8 kB / 2.155 GB, free: 1.559 MB / 1.729 GB
Notification: Performance of postOpt solveSimpleEquations (simulation): time 0.009291/3.428, allocations: 2.374 MB / 2.158 GB, free: 15.27 MB / 1.745 GB
Notification: Performance of postOpt tearingSystem (simulation): time 0.00161/3.429, allocations: 0.6361 MB / 2.158 GB, free: 14.61 MB / 1.745 GB
Notification: Performance of postOpt inputDerivativesUsed (simulation): time 0.002167/3.432, allocations: 267.8 kB / 2.159 GB, free: 14.35 MB / 1.745 GB
Notification: Performance of postOpt calculateStrongComponentJacobians (simulation): time 0.006536/3.438, allocations: 10.36 MB / 2.169 GB, free: 3.434 MB / 1.745 GB
Notification: Performance of postOpt calculateStateSetsJacobians (simulation): time 5.22e-06/3.438, allocations: 11.84 kB / 2.169 GB, free: 3.426 MB / 1.745 GB
Notification: Performance of postOpt symbolicJacobian (simulation): time 0.04903/3.487, allocations: 25.32 MB / 2.193 GB, free: 9.984 MB / 1.776 GB
Notification: Performance of postOpt removeConstants (simulation): time 0.0102/3.497, allocations: 3.119 MB / 2.196 GB, free: 6.852 MB / 1.776 GB
Notification: Performance of postOpt simplifyTimeIndepFuncCalls (simulation): time 0.005298/3.503, allocations: 211.9 kB / 2.197 GB, free: 6.645 MB / 1.776 GB
Notification: Performance of postOpt simplifyAllExpressions (simulation): time 0.0111/3.514, allocations: 1.147 MB / 2.198 GB, free: 5.504 MB / 1.776 GB
Notification: Performance of postOpt findZeroCrossings (simulation): time 0.002579/3.516, allocations: 0.6564 MB / 2.198 GB, free: 4.852 MB / 1.776 GB
Notification: Performance of postOpt collapseArrayExpressions (simulation): time 0.001903/3.518, allocations: 355.7 kB / 2.199 GB, free: 4.504 MB / 1.776 GB
Notification: Performance of sorting global known variables: time 0.6702/4.188, allocations: 8.893 MB / 2.207 GB, free: 461.6 MB / 1.776 GB
Notification: Performance of sort global known variables: time 9.12e-07/4.188, allocations: 1.094 kB / 2.207 GB, free: 461.6 MB / 1.776 GB
Notification: Performance of remove unused functions: time 0.02343/4.212, allocations: 6.488 MB / 2.214 GB, free: 461.6 MB / 1.776 GB
Notification: Model statistics after passing the back-end for simulation:
 * Number of independent subsystems: 24
 * Number of states: 37 (dataCenterContinuousTimeControl.cooCoi.ele[1].vol1.dynBal.U,dataCenterContinuousTimeControl.cooCoi.ele[1].vol2.dynBal.medium.Xi[1],dataCenterContinuousTimeControl.cooCoi.ele[1].vol2.dynBal.U,dataCenterContinuousTimeControl.cooCoi.ele[1].mas.T,dataCenterContinuousTimeControl.cooCoi.ele[2].vol1.dynBal.U,dataCenterContinuousTimeControl.cooCoi.ele[2].vol2.dynBal.medium.Xi[1],dataCenterContinuousTimeControl.cooCoi.ele[2].vol2.dynBal.U,dataCenterContinuousTimeControl.cooCoi.ele[2].mas.T,dataCenterContinuousTimeControl.cooCoi.ele[3].vol1.dynBal.U,dataCenterContinuousTimeControl.cooCoi.ele[3].vol2.dynBal.medium.Xi[1],dataCenterContinuousTimeControl.cooCoi.ele[3].vol2.dynBal.U,dataCenterContinuousTimeControl.cooCoi.ele[3].mas.T,dataCenterContinuousTimeControl.cooCoi.ele[4].vol1.dynBal.U,dataCenterContinuousTimeControl.cooCoi.ele[4].vol2.dynBal.medium.Xi[1],dataCenterContinuousTimeControl.cooCoi.ele[4].vol2.dynBal.U,dataCenterContinuousTimeControl.cooCoi.ele[4].vol2.dynBal.m,dataCenterContinuousTimeControl.cooCoi.ele[4].mas.T,dataCenterContinuousTimeControl.roo.rooVol.dynBal.medium.Xi[1],dataCenterContinuousTimeControl.roo.rooVol.dynBal.U,dataCenterContinuousTimeControl.roo.rooVol.dynBal.m,dataCenterContinuousTimeControl.pumCHW.vol.dynBal.U,dataCenterContinuousTimeControl.expVesCHW.m,dataCenterContinuousTimeControl.expVesCHW.H,dataCenterContinuousTimeControl.cooTow.vol.dynBal.U,dataCenterContinuousTimeControl.pumCW.vol.dynBal.U,dataCenterContinuousTimeControl.expVesChi.m,dataCenterContinuousTimeControl.expVesChi.H,dataCenterContinuousTimeControl.chi.vol1.dynBal.U,dataCenterContinuousTimeControl.chi.vol2.dynBal.U,dataCenterContinuousTimeControl.TAirSup.T,dataCenterContinuousTimeControl.TCHWEntChi.T,dataCenterContinuousTimeControl.TCWLeaTow.T,dataCenterContinuousTimeControl.TCHWLeaCoi.T,dataCenterContinuousTimeControl.EHVAC.y,dataCenterContinuousTimeControl.EIT.y,dataCenterContinuousTimeControl.triAndRes.conPID.I.y,bat.cha.SOC)
 * Number of discrete variables: 84 (dataCenterContinuousTimeControl.wseCon.T1.enableFire,con.t2.enableFire,con.t1.enableFire,dataCenterContinuousTimeControl.wseCon.T2.enableFire,con.discharge.active,con.discharge.localActive,con.charge.active,con.charge.localActive,con.off.localActive,dataCenterContinuousTimeControl.wseCon.on.localActive,dataCenterContinuousTimeControl.wseCon.off.active,$whenCondition12,$whenCondition11,$whenCondition10,$whenCondition9,$whenCondition8,$whenCondition7,$whenCondition6,$whenCondition5,$whenCondition4,$whenCondition3,$whenCondition2,$whenCondition1,dataCenterContinuousTimeControl.wseCon.off.localActive,dataCenterContinuousTimeControl.wseCon.off.newActive,dataCenterContinuousTimeControl.wseCon.off.oldActive,dataCenterContinuousTimeControl.wseCon.T1.localCondition,dataCenterContinuousTimeControl.wseCon.T1.fire,dataCenterContinuousTimeControl.wseCon.T1.t_start,dataCenterContinuousTimeControl.wseCon.on.active,dataCenterContinuousTimeControl.wseCon.on.newActive,dataCenterContinuousTimeControl.wseCon.on.oldActive,dataCenterContinuousTimeControl.wseCon.T2.localCondition,dataCenterContinuousTimeControl.wseCon.T2.fire,dataCenterContinuousTimeControl.wseCon.T2.t_start,dataCenterContinuousTimeControl.wseCon.stateGraphRoot.activeSteps,dataCenterContinuousTimeControl.chiSwi.hysteresis.y,dataCenterContinuousTimeControl.weaData.locTim.tNext,dataCenterContinuousTimeControl.weaData.locTim.k,dataCenterContinuousTimeControl.weaData.conTimMin.tNext,dataCenterContinuousTimeControl.weaData.conTimMin.k,dataCenterContinuousTimeControl.weaData.conTim.tNext,dataCenterContinuousTimeControl.weaData.conTim.k,dataCenterContinuousTimeControl.weaData.eqnTim.tNext,dataCenterContinuousTimeControl.weaData.eqnTim.k,dataCenterContinuousTimeControl.weaData.decAng.tNext,dataCenterContinuousTimeControl.weaData.decAng.k,dataCenterContinuousTimeControl.or1.u1,dataCenterContinuousTimeControl.or1.y,pv.HDifTil.incAng.decAng.tNext,pv.HDifTil.incAng.decAng.k,pv.HDirTil.incAng.decAng.tNext,pv.HDirTil.incAng.decAng.k,bat.cha.underCharged,bat.cha.overCharged,con.lessThreshold.y,con.not1.y,con.greaterThreshold.y,con.multiSwitch1.u[1],con.multiSwitch1.u[2],con.multiSwitch1.firstActiveIndex,con.off.active,con.off.inPort[1].set,con.off.outPort[1].reset,con.off.newActive,con.off.oldActive,con.stateGraphRoot.activeSteps,con.alternative.split[2].available,con.t1.localCondition,con.t1.fire,con.t1.t_start,con.t2.localCondition,con.t2.fire,con.t2.t_start,con.charge.newActive,con.charge.oldActive,con.discharge.newActive,con.discharge.oldActive,con.t3.localCondition,con.t3.enableFire,con.t4.localCondition,con.t4.enableFire,con.t3.t_start,con.t4.t_start)
 * Number of discrete states: 24 (con.t4.t_start,con.t3.t_start,pv.HDirTil.incAng.decAng.tNext,pv.HDifTil.incAng.decAng.tNext,dataCenterContinuousTimeControl.weaData.decAng.tNext,dataCenterContinuousTimeControl.weaData.eqnTim.tNext,dataCenterContinuousTimeControl.weaData.conTim.tNext,dataCenterContinuousTimeControl.weaData.conTimMin.tNext,dataCenterContinuousTimeControl.weaData.locTim.tNext,dataCenterContinuousTimeControl.wseCon.off.newActive,dataCenterContinuousTimeControl.wseCon.on.newActive,dataCenterContinuousTimeControl.chiSwi.hysteresis.y,bat.cha.underCharged,bat.cha.overCharged,con.off.newActive,con.charge.newActive,con.discharge.newActive,pv.HDirTil.incAng.decAng.k,pv.HDifTil.incAng.decAng.k,dataCenterContinuousTimeControl.weaData.decAng.k,dataCenterContinuousTimeControl.weaData.eqnTim.k,dataCenterContinuousTimeControl.weaData.conTim.k,dataCenterContinuousTimeControl.weaData.conTimMin.k,dataCenterContinuousTimeControl.weaData.locTim.k)
 * Number of clocked states: 0 ()
 * Top-level inputs: 0
Notification: Strong component statistics for simulation (899):
 * Single equations (assignments): 847
 * Array equations: 0
 * Algorithm blocks: 0
 * Record equations: 17
 * When equations: 25
 * If-equations: 0
 * Equation systems (not torn): 1
 * Torn equation systems: 9
 * Mixed (continuous/discrete) equation systems: 0
Notification: Equation system details (not torn):
 * Constant Jacobian (size): 0 systems
 * Linear Jacobian (size,density): 0 systems
 * Non-linear Jacobian (size): 1 system
   {1}
 * Without analytic Jacobian (size): 0 systems
Notification: Torn system details for strict tearing set:
 * Linear torn systems (#iteration vars, #inner vars, density): 3 systems
   {(1,1,100.0%), (1,1,100.0%), (1,7,100.0%)}
 * Non-linear torn systems (#iteration vars, #inner vars): 6 systems
   {(1,2), (1,2), (1,3), (3,13), (1,2), (2,9)}
Notification: Performance of Backend phase and start with SimCode phase: time 0.05478/4.267, allocations: 28.18 MB / 2.241 GB, free: 460 MB / 1.776 GB
Notification: Performance of simCode: created initialization part: time 0.05153/4.318, allocations: 25.34 MB / 2.266 GB, free: 458.8 MB / 1.776 GB
Notification: Performance of simCode: created event and clocks part: time 2.003e-05/4.318, allocations: 8.406 kB / 2.266 GB, free: 458.8 MB / 1.776 GB
Notification: Performance of simCode: created simulation system equations: time 0.01545/4.334, allocations: 8.308 MB / 2.274 GB, free: 458.3 MB / 1.776 GB
Notification: Performance of simCode: created of all other equations (e.g. parameter, nominal, assert, etc): time 0.02753/4.361, allocations: 7.617 MB / 2.282 GB, free: 457.3 MB / 1.776 GB
Notification: Performance of simCode: created linear, non-linear and system jacobian parts: time 0.2418/4.603, allocations: 125.9 MB / 2.405 GB, free: 406.7 MB / 1.776 GB
Notification: Performance of simCode: some other stuff during SimCode phase: time 0.01216/4.615, allocations: 8.289 MB / 2.413 GB, free: 398.5 MB / 1.776 GB
Notification: Performance of simCode: alias equations: time 0.01956/4.635, allocations: 5.304 MB / 2.418 GB, free: 393.3 MB / 1.776 GB
Notification: Performance of simCode: all other stuff during SimCode phase: time 0.01262/4.647, allocations: 7.402 MB / 2.425 GB, free: 385.9 MB / 1.776 GB
Notification: Performance of SimCode: time 1.572e-06/4.647, allocations: 0 / 2.425 GB, free: 385.9 MB / 1.776 GB
Notification: Performance of buildModelFMU: Generate the FMI files: time 0.8285/5.476, allocations: 443.4 MB / 2.858 GB, free: 0.807 GB / 1.823 GB
Notification: Performance of buildModelFMU: Generate platform static: time 34.7/40.17, allocations: 4.531 kB / 2.858 GB, free: 0.807 GB / 1.823 GB
"
[Timeout remaining time 259]
(rm -f Buildings_12_Buildings.Examples.ChillerPlant.DataCenterRenewables.pipe ; mkfifo Buildings_12_Buildings.Examples.ChillerPlant.DataCenterRenewables.pipe ; head -c 1048576 < Buildings_12_Buildings.Examples.ChillerPlant.DataCenterRenewables.pipe >> ../files/Buildings_12_Buildings.Examples.ChillerPlant.DataCenterRenewables.sim & /home/hudson/saved_omc/OMSimulator/install/bin/OMSimulator -r=Buildings_12_Buildings.Examples.ChillerPlant.DataCenterRenewables_res.mat --tempDir=temp_Buildings_12_Buildings_Examples_ChillerPlant_DataCenterRenewables_fmu --startTime=0 --stopTime=604800 --stepSize=241.92 --timeout=400 --tolerance=1e-06 Buildings_12_Buildings_Examples_ChillerPlant_DataCenterRenewables.fmu > Buildings_12_Buildings.Examples.ChillerPlant.DataCenterRenewables.pipe 2>&1) [Timeout 420.0]
[Calling os._exit(0), Time elapsed: 44.94216925557703]
Failed to read output from testmodel.py, exit status != 0:
40.52240302506834 40.532751369 38.035444903
Calling exit ...
<OMPython.OMCSessionZMQ object at 0x7ddd079c53d0>