Running: ./testmodel.py --libraries=/home/hudson/saved_omc/libraries/.openmodelica/libraries --ompython_omhome=/usr Buildings_9_Buildings.HeatTransfer.Windows.Examples.ElectrochromicWindow.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/Buildings 9.1.3-maint.9.1.x/package.mo", uses=false)
Using package Buildings with version 9.1.3 (/home/hudson/saved_omc/libraries/.openmodelica/libraries/Buildings 9.1.3-maint.9.1.x/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: translateModel(Buildings.HeatTransfer.Windows.Examples.ElectrochromicWindow,tolerance=1e-06,outputFormat="mat",numberOfIntervals=5000,variableFilter="time|uWin.y|window.glaUns.glass_a.T|window.glaUns.glass_b.T|extCon.radOut.TRad",fileNamePrefix="Buildings_9_Buildings.HeatTransfer.Windows.Examples.ElectrochromicWindow")
translateModel(Buildings.HeatTransfer.Windows.Examples.ElectrochromicWindow,tolerance=1e-06,outputFormat="mat",numberOfIntervals=5000,variableFilter="time|uWin.y|window.glaUns.glass_a.T|window.glaUns.glass_b.T|extCon.radOut.TRad",fileNamePrefix="Buildings_9_Buildings.HeatTransfer.Windows.Examples.ElectrochromicWindow")
Notification: Performance of loadFile(/home/hudson/saved_omc/libraries/.openmodelica/libraries/ModelicaServices 4.0.0+maint.om/package.mo): time 0.00137/0.00137, allocations: 109.8 kB / 16.42 MB, free: 6.469 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.001362/0.001362, allocations: 187.9 kB / 17.35 MB, free: 5.715 MB / 14.72 MB
Notification: Performance of loadFile(/home/hudson/saved_omc/libraries/.openmodelica/libraries/Modelica 4.0.0+maint.om/package.mo): time 1.3/1.3, allocations: 222.9 MB / 241 MB, free: 15.14 MB / 206.1 MB
Notification: Performance of loadFile(/home/hudson/saved_omc/libraries/.openmodelica/libraries/Buildings 9.1.3-maint.9.1.x/package.mo): time 2.165/2.165, allocations: 390.2 MB / 0.6655 GB, free: 0.6094 MB / 0.5294 GB
Notification: Performance of FrontEnd - loaded program: time 0.001278/0.001278, allocations: 63.91 kB / 0.9516 GB, free: 7.594 MB / 0.7325 GB
Notification: Performance of FrontEnd - Absyn->SCode: time 0.7194/0.7207, allocations: 140.4 MB / 1.089 GB, free: 5.484 MB / 0.8575 GB
Notification: Performance of NFInst.instantiate(Buildings.HeatTransfer.Windows.Examples.ElectrochromicWindow): time 0.01346/0.7342, allocations: 13.5 MB / 1.102 GB, free: 11.77 MB / 0.8731 GB
Notification: Performance of NFInst.instExpressions: time 0.1872/0.9214, allocations: 163.2 MB / 1.261 GB, free: 12.98 MB / 0.9981 GB
Notification: Performance of NFInst.updateImplicitVariability: time 0.003438/0.9249, allocations: 67.69 kB / 1.261 GB, free: 12.91 MB / 0.9981 GB
Notification: Performance of NFTyping.typeComponents: time 0.006444/0.9314, allocations: 2.415 MB / 1.264 GB, free: 10.49 MB / 0.9981 GB
Notification: Performance of NFTyping.typeBindings: time 0.004909/0.9363, allocations: 1.573 MB / 1.265 GB, free: 8.914 MB / 0.9981 GB
Notification: Performance of NFTyping.typeClassSections: time 0.005844/0.9422, allocations: 2.192 MB / 1.267 GB, free: 6.727 MB / 0.9981 GB
Notification: Performance of NFFlatten.flatten: time 0.007686/0.9499, allocations: 7.036 MB / 1.274 GB, free: 15.67 MB / 1.014 GB
Notification: Performance of NFFlatten.resolveConnections: time 0.002972/0.9529, allocations: 1.981 MB / 1.276 GB, free: 13.62 MB / 1.014 GB
Notification: Performance of NFEvalConstants.evaluate: time 0.003523/0.9564, allocations: 2.345 MB / 1.278 GB, free: 11.27 MB / 1.014 GB
Notification: Performance of NFSimplifyModel.simplify: time 0.00333/0.9598, allocations: 2.195 MB / 1.281 GB, free: 9.066 MB / 1.014 GB
Notification: Performance of NFPackage.collectConstants: time 0.001133/0.9609, allocations: 436 kB / 1.281 GB, free: 8.641 MB / 1.014 GB
Notification: Performance of NFFlatten.collectFunctions: time 0.005945/0.9669, allocations: 2.938 MB / 1.284 GB, free: 5.699 MB / 1.014 GB
Notification: Performance of NFScalarize.scalarize: time 0.004709/0.9716, allocations: 4.701 MB / 1.288 GB, free: 0.9805 MB / 1.014 GB
Notification: Performance of NFVerifyModel.verify: time 0.004633/0.9762, allocations: 2.375 MB / 1.291 GB, free: 14.59 MB / 1.029 GB
Notification: Performance of NFConvertDAE.convert: time 0.01127/0.9875, allocations: 8.261 MB / 1.299 GB, free: 6.309 MB / 1.029 GB
Notification: Performance of FrontEnd - DAE generated: time 4.659e-06/0.9876, allocations: 0 / 1.299 GB, free: 6.309 MB / 1.029 GB
Notification: Performance of FrontEnd: time 1.763e-06/0.9876, allocations: 0 / 1.299 GB, free: 6.309 MB / 1.029 GB
Notification: Performance of Transformations before backend: time 0.0001187/0.9877, allocations: 0 / 1.299 GB, free: 6.309 MB / 1.029 GB
Notification: Model statistics after passing the front-end and creating the data structures used by the back-end:
 * Number of equations: 593
 * Number of variables: 593
Notification: Performance of Generate backend data structure: time 0.0101/0.9978, allocations: 5.589 MB / 1.304 GB, free: 0.625 MB / 1.029 GB
Notification: Performance of prepare preOptimizeDAE: time 3.956e-05/0.9978, allocations: 8.031 kB / 1.304 GB, free: 0.6172 MB / 1.029 GB
Notification: Performance of preOpt normalInlineFunction (simulation): time 0.01611/1.014, allocations: 2.757 MB / 1.307 GB, free: 13.85 MB / 1.045 GB
Notification: Performance of preOpt evaluateParameters (simulation): time 0.02638/1.04, allocations: 15.15 MB / 1.322 GB, free: 14.61 MB / 1.061 GB
Notification: Performance of preOpt simplifyIfEquations (simulation): time 0.0002189/1.041, allocations: 220.4 kB / 1.322 GB, free: 14.39 MB / 1.061 GB
Notification: Performance of preOpt expandDerOperator (simulation): time 0.0009074/1.042, allocations: 308 kB / 1.322 GB, free: 14.09 MB / 1.061 GB
Notification: Performance of preOpt clockPartitioning (simulation): time 0.007742/1.049, allocations: 3.85 MB / 1.326 GB, free: 10.11 MB / 1.061 GB
Notification: Performance of preOpt findStateOrder (simulation): time 3.682e-05/1.049, allocations: 3.938 kB / 1.326 GB, free: 10.11 MB / 1.061 GB
Notification: Performance of preOpt replaceEdgeChange (simulation): time 0.0002778/1.05, allocations: 92 kB / 1.326 GB, free: 10.02 MB / 1.061 GB
Notification: Performance of preOpt inlineArrayEqn (simulation): time 4.054e-05/1.05, allocations: 56 kB / 1.326 GB, free: 9.961 MB / 1.061 GB
Notification: Performance of preOpt removeEqualRHS (simulation): time 0.007325/1.057, allocations: 3.694 MB / 1.33 GB, free: 6.25 MB / 1.061 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.02839/1.085, allocations: 21.74 MB / 1.351 GB, free: 15.79 MB / 1.092 GB
Notification: Performance of preOpt comSubExp (simulation): time 0.007098/1.093, allocations: 3.278 MB / 1.354 GB, free: 12.5 MB / 1.092 GB
Notification: Performance of preOpt resolveLoops (simulation): time 0.004323/1.097, allocations: 2.215 MB / 1.356 GB, free: 10.28 MB / 1.092 GB
Notification: Performance of preOpt evalFunc (simulation): time 0.0004803/1.097, allocations: 429.8 kB / 1.357 GB, free: 9.785 MB / 1.092 GB
Notification: Performance of preOpt encapsulateWhenConditions (simulation): time 0.004992/1.102, allocations: 2.354 MB / 1.359 GB, free: 7.402 MB / 1.092 GB
Notification: Performance of pre-optimization done (n=185): time 7.113e-06/1.102, allocations: 0 / 1.359 GB, free: 7.402 MB / 1.092 GB
Notification: Performance of matching and sorting (n=185): time 0.02482/1.127, allocations: 8.351 MB / 1.367 GB, free: 14.97 MB / 1.107 GB
Notification: Performance of inlineWhenForInitialization (initialization): time 0.0002938/1.128, allocations: 418.3 kB / 1.368 GB, free: 14.5 MB / 1.107 GB
Notification: Performance of selectInitializationVariablesDAE (initialization): time 0.03183/1.159, allocations: 21.55 MB / 1.389 GB, free: 8.938 MB / 1.123 GB
Notification: Performance of collectPreVariables (initialization): time 0.0007572/1.16, allocations: 97.64 kB / 1.389 GB, free: 8.836 MB / 1.123 GB
Notification: Performance of collectInitialEqns (initialization): time 0.002105/1.162, allocations: 1.639 MB / 1.39 GB, free: 7.18 MB / 1.123 GB
Notification: Performance of collectInitialBindings (initialization): time 0.0008569/1.163, allocations: 0.6201 MB / 1.391 GB, free: 6.551 MB / 1.123 GB
Notification: Performance of simplifyInitialFunctions (initialization): time 0.005039/1.168, allocations: 5.093 MB / 1.396 GB, free: 1.426 MB / 1.123 GB
Notification: Performance of setup shared object (initialization): time 9.031e-05/1.168, allocations: 313.1 kB / 1.396 GB, free: 1.117 MB / 1.123 GB
Notification: Performance of preBalanceInitialSystem (initialization): time 0.03836/1.207, allocations: 40.11 MB / 1.435 GB, free: 8.988 MB / 1.17 GB
Notification: Performance of partitionIndependentBlocks (initialization): time 0.03965/1.246, allocations: 41.62 MB / 1.476 GB, free: 15.04 MB / 1.217 GB
Notification: Performance of analyzeInitialSystem (initialization): time 0.05357/1.3, allocations: 49.83 MB / 1.525 GB, free: 12.69 MB / 1.264 GB
Notification: Performance of solveInitialSystemEqSystem (initialization): time 3.52e-05/1.3, allocations: 4 kB / 1.525 GB, free: 12.68 MB / 1.264 GB
Notification: Performance of matching and sorting (n=1918) (initialization): time 0.5935/1.894, allocations: 94.73 MB / 1.617 GB, free: 423.4 MB / 1.311 GB
Notification: Performance of prepare postOptimizeDAE: time 0.0002513/1.894, allocations: 202.3 kB / 1.617 GB, free: 423.3 MB / 1.311 GB
Notification: Performance of postOpt simplifyComplexFunction (initialization): time 0.08856/1.982, allocations: 68.35 MB / 1.684 GB, free: 380.4 MB / 1.311 GB
Notification: Performance of postOpt tearingSystem (initialization): time 0.04564/2.028, allocations: 5.761 MB / 1.69 GB, free: 376.5 MB / 1.311 GB
Notification: Performance of postOpt solveSimpleEquations (initialization): time 0.004556/2.033, allocations: 0.9048 MB / 1.691 GB, free: 375.8 MB / 1.311 GB
Notification: Performance of postOpt calculateStrongComponentJacobians (initialization): time 0.006836/2.04, allocations: 6.76 MB / 1.697 GB, free: 369.1 MB / 1.311 GB
Notification: Performance of postOpt simplifyAllExpressions (initialization): time 0.0055/2.045, allocations: 0.6484 MB / 1.698 GB, free: 368.7 MB / 1.311 GB
Notification: Performance of postOpt collapseArrayExpressions (initialization): time 0.0005656/2.046, allocations: 202.7 kB / 1.698 GB, free: 368.6 MB / 1.311 GB
Notification: Performance of preBalanceInitialSystem (initialization_lambda0): time 0.03061/2.076, allocations: 42.47 MB / 1.74 GB, free: 328.4 MB / 1.311 GB
Notification: Performance of partitionIndependentBlocks (initialization_lambda0): time 0.02978/2.106, allocations: 41.62 MB / 1.78 GB, free: 287.1 MB / 1.311 GB
Notification: Performance of analyzeInitialSystem (initialization_lambda0): time 0.0398/2.146, allocations: 49.81 MB / 1.829 GB, free: 237.1 MB / 1.311 GB
Notification: Performance of solveInitialSystemEqSystem (initialization_lambda0): time 3.2e-05/2.146, allocations: 8 kB / 1.829 GB, free: 237.1 MB / 1.311 GB
Notification: Performance of matching and sorting (n=1918) (initialization_lambda0): time 0.08018/2.226, allocations: 94.18 MB / 1.921 GB, free: 142.5 MB / 1.311 GB
Notification: Performance of prepare postOptimizeDAE: time 0.000178/2.226, allocations: 201.5 kB / 1.921 GB, free: 142.3 MB / 1.311 GB
Notification: Performance of postOpt simplifyComplexFunction (initialization): time 0.05925/2.286, allocations: 65.88 MB / 1.985 GB, free: 76.05 MB / 1.311 GB
Notification: Performance of postOpt tearingSystem (initialization): time 0.001603/2.287, allocations: 0.5224 MB / 1.986 GB, free: 75.52 MB / 1.311 GB
Notification: Performance of postOpt solveSimpleEquations (initialization): time 0.004812/2.292, allocations: 0.9633 MB / 1.987 GB, free: 74.56 MB / 1.311 GB
Notification: Performance of postOpt calculateStrongComponentJacobians (initialization): time 0.0073/2.299, allocations: 9.004 MB / 1.996 GB, free: 65.03 MB / 1.311 GB
Notification: Performance of postOpt simplifyAllExpressions (initialization): time 0.005457/2.305, allocations: 0.5626 MB / 1.996 GB, free: 64.51 MB / 1.311 GB
Notification: Performance of postOpt collapseArrayExpressions (initialization): time 0.0005575/2.305, allocations: 203.8 kB / 1.996 GB, free: 64.31 MB / 1.311 GB
Notification: Model statistics after passing the back-end for initialization:
 * Number of independent subsystems: 98
 * Number of states: 0 ()
 * Number of discrete variables: 20 (weaDat.conTim.canRepeatWeatherFile,weaDat.conTimMin.canRepeatWeatherFile,weaDat.decAng.tNext,$PRE.weaDat.decAng.tNext,weaDat.eqnTim.tNext,$PRE.weaDat.eqnTim.tNext,weaDat.conTim.tNext,$PRE.weaDat.conTim.tNext,weaDat.conTimMin.tNext,$PRE.weaDat.conTimMin.tNext,weaDat.locTim.tNext,$PRE.weaDat.locTim.tNext,HDirTil.incAng.decAng.tNext,$PRE.HDirTil.incAng.decAng.tNext,$whenCondition1,$whenCondition2,$whenCondition3,$whenCondition4,$whenCondition5,$whenCondition6)
 * Number of discrete states: 0 ()
 * Number of clocked states: 0 ()
 * Top-level inputs: 0
Notification: Strong component statistics for initialization (429):
 * Single equations (assignments): 385
 * Array equations: 39
 * Algorithm blocks: 1
 * Record equations: 0
 * When equations: 0
 * If-equations: 0
 * Equation systems (not torn): 1
 * Torn equation systems: 3
 * 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): 1 system
   {(1,6,100.0%)}
 * Non-linear torn systems (#iteration vars, #inner vars): 2 systems
   {(5,23), (1,2)}
Notification: Performance of prepare postOptimizeDAE: time 0.001098/2.307, allocations: 0.5703 MB / 1.997 GB, free: 63.73 MB / 1.311 GB
Notification: Performance of postOpt lateInlineFunction (simulation): time 0.0006709/2.307, allocations: 362.2 kB / 1.997 GB, free: 63.38 MB / 1.311 GB
Notification: Performance of postOpt wrapFunctionCalls (simulation): time 0.01269/2.32, allocations: 6.331 MB / 2.003 GB, free: 57.01 MB / 1.311 GB
Notification: Performance of postOpt simplifysemiLinear (simulation): time 2.394e-05/2.32, allocations: 7.969 kB / 2.003 GB, free: 57 MB / 1.311 GB
Notification: Performance of postOpt simplifyComplexFunction (simulation): time 0.03336/2.353, allocations: 7.595 MB / 2.011 GB, free: 49.39 MB / 1.311 GB
Notification: Performance of postOpt removeConstants (simulation): time 0.001999/2.355, allocations: 0.8278 MB / 2.012 GB, free: 48.54 MB / 1.311 GB
Notification: Performance of postOpt simplifyTimeIndepFuncCalls (simulation): time 0.0006622/2.356, allocations: 43.98 kB / 2.012 GB, free: 48.5 MB / 1.311 GB
Notification: Performance of postOpt simplifyAllExpressions (simulation): time 0.002543/2.359, allocations: 251.6 kB / 2.012 GB, free: 48.25 MB / 1.311 GB
Notification: Performance of postOpt findZeroCrossings (simulation): time 0.0002772/2.359, allocations: 145.8 kB / 2.012 GB, free: 48.11 MB / 1.311 GB
Notification: Performance of postOpt createDAEmodeBDAE (simulation): time 0.01482/2.374, allocations: 6.73 MB / 2.019 GB, free: 41.38 MB / 1.311 GB
Notification: Performance of postOpt symbolicJacobianDAE (simulation): time 0.01265/2.386, allocations: 7.802 MB / 2.026 GB, free: 33.55 MB / 1.311 GB
Notification: Performance of postOpt setEvaluationStage (simulation): time 0.003841/2.39, allocations: 2.971 MB / 2.029 GB, free: 30.57 MB / 1.311 GB
Notification: Performance of sorting global known variables: time 0.008434/2.399, allocations: 13.45 MB / 2.042 GB, free: 17.12 MB / 1.311 GB
Notification: Performance of Backend: time 8.42e-07/2.399, allocations: 0 / 2.042 GB, free: 17.12 MB / 1.311 GB
Notification: Performance of simCode: created initialization part: time 0.5663/2.965, allocations: 104 MB / 2.144 GB, free: 454 MB / 1.342 GB
Notification: Performance of SimCode: time 0.02396/2.989, allocations: 21.54 MB / 2.165 GB, free: 446.3 MB / 1.342 GB
Notification: Performance of Templates: time 0.3228/3.312, allocations: 141.3 MB / 2.303 GB, free: 312.8 MB / 1.342 GB
make -j1 -f Buildings_9_Buildings.HeatTransfer.Windows.Examples.ElectrochromicWindow.makefile
(rm -f Buildings_9_Buildings.HeatTransfer.Windows.Examples.ElectrochromicWindow.pipe ; mkfifo Buildings_9_Buildings.HeatTransfer.Windows.Examples.ElectrochromicWindow.pipe ; head -c 1048576 < Buildings_9_Buildings.HeatTransfer.Windows.Examples.ElectrochromicWindow.pipe >> ../files/Buildings_9_Buildings.HeatTransfer.Windows.Examples.ElectrochromicWindow.sim & ./Buildings_9_Buildings.HeatTransfer.Windows.Examples.ElectrochromicWindow  -abortSlowSimulation -alarm=480  -emit_protected -lv LOG_STATS > Buildings_9_Buildings.HeatTransfer.Windows.Examples.ElectrochromicWindow.pipe 2>&1)