Running: ./testmodel.py --libraries=/home/hudson/saved_omc/libraries/.openmodelica/libraries --ompython_omhome=/usr ModelicaTest_trunk_ModelicaTest.Electrical.PowerConverters.HalfControlledBridge2mPulse.conf.json
loadFile("/home/hudson/saved_omc/libraries/.openmodelica/libraries/ModelicaServices trunk/package.mo", uses=false)
loadFile("/home/hudson/saved_omc/libraries/.openmodelica/libraries/Complex trunk/package.mo", uses=false)
loadFile("/home/hudson/saved_omc/libraries/.openmodelica/libraries/Modelica trunk/package.mo", uses=false)
loadFile("/home/hudson/saved_omc/libraries/.openmodelica/libraries/ModelicaTest trunk/package.mo", uses=false)
Using package ModelicaTest with version trunk (/home/hudson/saved_omc/libraries/.openmodelica/libraries/ModelicaTest trunk/package.mo)
Using package Modelica with version trunk (/home/hudson/saved_omc/libraries/.openmodelica/libraries/Modelica trunk/package.mo)
Using package Complex with version trunk (/home/hudson/saved_omc/libraries/.openmodelica/libraries/Complex trunk/package.mo)
Using package ModelicaServices with version trunk (/home/hudson/saved_omc/libraries/.openmodelica/libraries/ModelicaServices trunk/package.mo)
Running command: translateModel(ModelicaTest.Electrical.PowerConverters.HalfControlledBridge2mPulse,tolerance=1e-06,outputFormat="mat",numberOfIntervals=1000,variableFilter="time|meanCurrent.x|meanVoltage.x|rootMeanSquareVoltage.mean.x|meanCurrent.y|meanVoltage.y|pulse2m.twomPulse.timerNegative.1..entryTime|pulse2m.twomPulse.timerNegative.2..entryTime|pulse2m.twomPulse.timerNegative.3..entryTime|pulse2m.twomPulse.timerPositive.1..entryTime|pulse2m.twomPulse.timerPositive.2..entryTime|pulse2m.twomPulse.timerPositive.3..entryTime|rectifier.pre.1..u|rectifier.pre.2..u|rectifier.pre.3..u|rectifier.thyristor_p.idealThyristor.1..off|rectifier.thyristor_p.idealThyristor.2..off|rectifier.thyristor_p.idealThyristor.3..off|rootMeanSquareVoltage.mean.y",fileNamePrefix="ModelicaTest_trunk_ModelicaTest.Electrical.PowerConverters.HalfControlledBridge2mPulse")
translateModel(ModelicaTest.Electrical.PowerConverters.HalfControlledBridge2mPulse,tolerance=1e-06,outputFormat="mat",numberOfIntervals=1000,variableFilter="time|meanCurrent.x|meanVoltage.x|rootMeanSquareVoltage.mean.x|meanCurrent.y|meanVoltage.y|pulse2m.twomPulse.timerNegative.1..entryTime|pulse2m.twomPulse.timerNegative.2..entryTime|pulse2m.twomPulse.timerNegative.3..entryTime|pulse2m.twomPulse.timerPositive.1..entryTime|pulse2m.twomPulse.timerPositive.2..entryTime|pulse2m.twomPulse.timerPositive.3..entryTime|rectifier.pre.1..u|rectifier.pre.2..u|rectifier.pre.3..u|rectifier.thyristor_p.idealThyristor.1..off|rectifier.thyristor_p.idealThyristor.2..off|rectifier.thyristor_p.idealThyristor.3..off|rootMeanSquareVoltage.mean.y",fileNamePrefix="ModelicaTest_trunk_ModelicaTest.Electrical.PowerConverters.HalfControlledBridge2mPulse")
Notification: Performance of loadFile(/home/hudson/saved_omc/libraries/.openmodelica/libraries/ModelicaServices trunk/package.mo): time 0.00113/0.001131, allocations: 111.6 kB / 18.46 MB, free: 4.594 MB / 14.72 MB
Notification: Performance of loadFile(/home/hudson/saved_omc/libraries/.openmodelica/libraries/Complex trunk/package.mo): time 0.001202/0.001202, allocations: 207.9 kB / 19.41 MB, free: 3.648 MB / 14.72 MB
Notification: Performance of loadFile(/home/hudson/saved_omc/libraries/.openmodelica/libraries/Modelica trunk/package.mo): time 1.368/1.368, allocations: 227.4 MB / 247.6 MB, free: 10.47 MB / 206.1 MB
Notification: Performance of loadFile(/home/hudson/saved_omc/libraries/.openmodelica/libraries/ModelicaTest trunk/package.mo): time 0.2158/0.2158, allocations: 46.11 MB / 345 MB, free: 11.52 MB / 286.1 MB
Notification: Performance of FrontEnd - loaded program: time 0.001415/0.001415, allocations: 71.83 kB / 482 MB, free: 4.117 MB / 350.1 MB
Notification: Performance of FrontEnd - Absyn->SCode: time 0.3172/0.3186, allocations: 62.44 MB / 0.5317 GB, free: 13.61 MB / 398.1 MB
Notification: Performance of NFInst.instantiate(ModelicaTest.Electrical.PowerConverters.HalfControlledBridge2mPulse): time 0.007936/0.3266, allocations: 6.497 MB / 0.538 GB, free: 8.488 MB / 398.1 MB
Notification: Performance of NFInst.instExpressions: time 0.004484/0.3311, allocations: 1.993 MB / 0.5399 GB, free: 6.836 MB / 398.1 MB
Notification: Performance of NFInst.updateImplicitVariability: time 0.0009351/0.3321, allocations: 47.06 kB / 0.54 GB, free: 6.82 MB / 398.1 MB
Notification: Performance of NFTyping.typeComponents: time 0.0009723/0.3331, allocations: 328.1 kB / 0.5403 GB, free: 6.543 MB / 398.1 MB
Notification: Performance of NFTyping.typeBindings: time 0.001185/0.3344, allocations: 476.9 kB / 0.5408 GB, free: 6.156 MB / 398.1 MB
Notification: Performance of NFTyping.typeClassSections: time 0.0007549/0.3351, allocations: 408.4 kB / 0.5411 GB, free: 5.805 MB / 398.1 MB
Notification: Performance of NFFlatten.flatten: time 0.002617/0.3377, allocations: 2.556 MB / 0.5436 GB, free: 4.25 MB / 398.1 MB
Notification: Performance of NFFlatten.resolveConnections: time 0.002171/0.3399, allocations: 1.941 MB / 0.5455 GB, free: 3.246 MB / 398.1 MB
Notification: Performance of NFEvalConstants.evaluate: time 0.001525/0.3415, allocations: 1.113 MB / 0.5466 GB, free: 2.336 MB / 398.1 MB
Notification: Performance of NFSimplifyModel.simplify: time 0.001405/0.3429, allocations: 1.241 MB / 0.5478 GB, free: 1.09 MB / 398.1 MB
Notification: Performance of NFPackage.collectConstants: time 0.0003515/0.3432, allocations: 292 kB / 0.5481 GB, free: 0.8047 MB / 398.1 MB
Notification: Performance of NFFlatten.collectFunctions: time 0.0004745/0.3437, allocations: 296 kB / 0.5484 GB, free: 0.5156 MB / 398.1 MB
Notification: Performance of NFScalarize.scalarize: time 0.0005795/0.3443, allocations: 0.748 MB / 0.5491 GB, free: 15.77 MB / 414.1 MB
Notification: Performance of NFVerifyModel.verify: time 0.00116/0.3455, allocations: 1.256 MB / 0.5504 GB, free: 14.5 MB / 414.1 MB
Notification: Performance of NFConvertDAE.convert: time 0.003189/0.3487, allocations: 3.682 MB / 0.554 GB, free: 10.81 MB / 414.1 MB
Notification: Performance of FrontEnd - DAE generated: time 5.32e-06/0.3487, allocations: 0 / 0.554 GB, free: 10.81 MB / 414.1 MB
Notification: Performance of FrontEnd: time 1.212e-06/0.3487, allocations: 0 / 0.554 GB, free: 10.81 MB / 414.1 MB
Notification: Performance of Transformations before backend: time 3.963e-05/0.3488, allocations: 0 / 0.554 GB, free: 10.81 MB / 414.1 MB
Notification: Model statistics after passing the front-end and creating the data structures used by the back-end:
 * Number of equations: 470
 * Number of variables: 470
Notification: Performance of Generate backend data structure: time 0.004579/0.3533, allocations: 2.672 MB / 0.5566 GB, free: 8.074 MB / 414.1 MB
Notification: Performance of prepare preOptimizeDAE: time 4.545e-05/0.3534, allocations: 8.031 kB / 0.5566 GB, free: 8.066 MB / 414.1 MB
Notification: Performance of preOpt normalInlineFunction (simulation): time 0.0006561/0.3541, allocations: 270.1 kB / 0.5568 GB, free: 7.801 MB / 414.1 MB
Notification: Performance of preOpt evaluateParameters (simulation): time 0.002145/0.3562, allocations: 1.475 MB / 0.5583 GB, free: 6.27 MB / 414.1 MB
Notification: Performance of preOpt simplifyIfEquations (simulation): time 0.0001088/0.3563, allocations: 144 kB / 0.5584 GB, free: 6.129 MB / 414.1 MB
Notification: Performance of preOpt expandDerOperator (simulation): time 0.0002589/0.3566, allocations: 188.1 kB / 0.5586 GB, free: 5.945 MB / 414.1 MB
Notification: Performance of preOpt clockPartitioning (simulation): time 0.003813/0.3604, allocations: 2.6 MB / 0.5611 GB, free: 3.301 MB / 414.1 MB
Notification: Performance of preOpt findStateOrder (simulation): time 3.791e-05/0.3605, allocations: 4 kB / 0.5611 GB, free: 3.297 MB / 414.1 MB
Notification: Performance of preOpt replaceEdgeChange (simulation): time 0.0001665/0.3606, allocations: 83.92 kB / 0.5612 GB, free: 3.215 MB / 414.1 MB
Notification: Performance of preOpt inlineArrayEqn (simulation): time 7.611e-05/0.3607, allocations: 71.62 kB / 0.5613 GB, free: 3.145 MB / 414.1 MB
Notification: Performance of preOpt removeEqualRHS (simulation): time 0.00338/0.3641, allocations: 2.278 MB / 0.5635 GB, free: 0.8633 MB / 414.1 MB
Notification: Performance of preOpt removeSimpleEquations (simulation): time 0.01014/0.3743, allocations: 7.23 MB / 0.5706 GB, free: 9.512 MB / 430.1 MB
Notification: Performance of preOpt comSubExp (simulation): time 0.002437/0.3767, allocations: 1.819 MB / 0.5723 GB, free: 7.695 MB / 430.1 MB
Notification: Performance of preOpt resolveLoops (simulation): time 0.002454/0.3792, allocations: 1.388 MB / 0.5737 GB, free: 6.309 MB / 430.1 MB
Notification: Performance of preOpt evalFunc (simulation): time 5.943e-05/0.3793, allocations: 13 kB / 0.5737 GB, free: 6.293 MB / 430.1 MB
Notification: Performance of preOpt encapsulateWhenConditions (simulation): time 0.001405/0.3807, allocations: 1 MB / 0.5747 GB, free: 5.262 MB / 430.1 MB
Notification: Performance of pre-optimization done (n=134): time 3.206e-06/0.3807, allocations: 0 / 0.5747 GB, free: 5.262 MB / 430.1 MB
Notification: Performance of matching and sorting (n=134): time 0.008459/0.3892, allocations: 3.843 MB / 0.5784 GB, free: 1.391 MB / 430.1 MB
Notification: Performance of inlineWhenForInitialization (initialization): time 0.0001174/0.3893, allocations: 256.6 kB / 0.5787 GB, free: 1.082 MB / 430.1 MB
Notification: Performance of selectInitializationVariablesDAE (initialization): time 0.001871/0.3912, allocations: 1.344 MB / 0.58 GB, free: 15.73 MB / 446.1 MB
Notification: Performance of collectPreVariables (initialization): time 0.0001321/0.3913, allocations: 73.69 kB / 0.5801 GB, free: 15.65 MB / 446.1 MB
Notification: Performance of collectInitialEqns (initialization): time 0.0007324/0.392, allocations: 0.824 MB / 0.5809 GB, free: 14.81 MB / 446.1 MB
Notification: Performance of collectInitialBindings (initialization): time 0.0003904/0.3924, allocations: 410.3 kB / 0.5813 GB, free: 14.41 MB / 446.1 MB
Notification: Performance of simplifyInitialFunctions (initialization): time 0.0004362/0.3929, allocations: 283.4 kB / 0.5815 GB, free: 14.12 MB / 446.1 MB
Notification: Performance of setup shared object (initialization): time 0.0001575/0.3931, allocations: 357.9 kB / 0.5819 GB, free: 13.77 MB / 446.1 MB
Notification: Performance of preBalanceInitialSystem (initialization): time 0.001183/0.3943, allocations: 0.7347 MB / 0.5826 GB, free: 13.03 MB / 446.1 MB
Notification: Performance of partitionIndependentBlocks (initialization): time 0.001357/0.3956, allocations: 1.073 MB / 0.5836 GB, free: 11.84 MB / 446.1 MB
Notification: Performance of analyzeInitialSystem (initialization): time 0.002291/0.3979, allocations: 1.626 MB / 0.5852 GB, free: 10.11 MB / 446.1 MB
Notification: Performance of solveInitialSystemEqSystem (initialization): time 7.064e-06/0.3979, allocations: 0 / 0.5852 GB, free: 10.11 MB / 446.1 MB
Notification: Performance of matching and sorting (n=179) (initialization): time 0.003333/0.4013, allocations: 2.187 MB / 0.5874 GB, free: 7.914 MB / 446.1 MB
Notification: Performance of prepare postOptimizeDAE: time 2.085e-05/0.4013, allocations: 12 kB / 0.5874 GB, free: 7.902 MB / 446.1 MB
Notification: Performance of postOpt simplifyComplexFunction (initialization): time 1.533e-05/0.4013, allocations: 4 kB / 0.5874 GB, free: 7.898 MB / 446.1 MB
Notification: Performance of postOpt tearingSystem (initialization): time 0.001229/0.4026, allocations: 0.5432 MB / 0.5879 GB, free: 7.352 MB / 446.1 MB
Notification: Performance of postOpt solveSimpleEquations (initialization): time 0.0007024/0.4033, allocations: 191.7 kB / 0.5881 GB, free: 7.164 MB / 446.1 MB
Notification: Performance of postOpt calculateStrongComponentJacobians (initialization): time 0.008037/0.4113, allocations: 6.35 MB / 0.5943 GB, free: 0.6719 MB / 446.1 MB
Notification: Performance of postOpt simplifyAllExpressions (initialization): time 0.001055/0.4124, allocations: 190.7 kB / 0.5945 GB, free: 496 kB / 446.1 MB
Notification: Performance of postOpt collapseArrayExpressions (initialization): time 0.0001108/0.4125, allocations: 51.98 kB / 0.5945 GB, free: 444 kB / 446.1 MB
Notification: Performance of preBalanceInitialSystem (initialization_lambda0): time 0.002113/0.4146, allocations: 1.347 MB / 0.5958 GB, free: 15.08 MB / 462.1 MB
Notification: Performance of partitionIndependentBlocks (initialization_lambda0): time 0.001396/0.416, allocations: 1.05 MB / 0.5969 GB, free: 13.91 MB / 462.1 MB
Notification: Performance of analyzeInitialSystem (initialization_lambda0): time 0.002446/0.4185, allocations: 1.61 MB / 0.5984 GB, free: 12.2 MB / 462.1 MB
Notification: Performance of solveInitialSystemEqSystem (initialization_lambda0): time 1.042e-05/0.4185, allocations: 7.984 kB / 0.5984 GB, free: 12.2 MB / 462.1 MB
Notification: Performance of matching and sorting (n=179) (initialization_lambda0): time 0.00358/0.4221, allocations: 2.163 MB / 0.6006 GB, free: 10.02 MB / 462.1 MB
Notification: Performance of prepare postOptimizeDAE: time 1.774e-05/0.4221, allocations: 10.19 kB / 0.6006 GB, free: 10.01 MB / 462.1 MB
Notification: Performance of postOpt simplifyComplexFunction (initialization): time 1.306e-05/0.4222, allocations: 11.94 kB / 0.6006 GB, free: 10 MB / 462.1 MB
Notification: Performance of postOpt tearingSystem (initialization): time 0.00119/0.4234, allocations: 0.5362 MB / 0.6011 GB, free: 9.461 MB / 462.1 MB
Notification: Performance of postOpt solveSimpleEquations (initialization): time 0.000676/0.4241, allocations: 207.6 kB / 0.6013 GB, free: 9.258 MB / 462.1 MB
Notification: Performance of postOpt calculateStrongComponentJacobians (initialization): time 0.008215/0.4323, allocations: 6.33 MB / 0.6075 GB, free: 2.785 MB / 462.1 MB
Notification: Performance of postOpt simplifyAllExpressions (initialization): time 0.001209/0.4335, allocations: 199 kB / 0.6077 GB, free: 2.59 MB / 462.1 MB
Notification: Performance of postOpt collapseArrayExpressions (initialization): time 0.0001292/0.4336, allocations: 48 kB / 0.6077 GB, free: 2.543 MB / 462.1 MB
Notification: Model statistics after passing the back-end for initialization:
 * Number of independent subsystems: 32
 * Number of states: 0 ()
 * Number of discrete variables: 57 (meanVoltage.y_last,$PRE.meanVoltage.y_last,meanCurrent.y_last,$PRE.meanCurrent.y_last,$whenCondition9,$whenCondition8,$whenCondition7,rootMeanSquareVoltage.mean.y_last,$PRE.rootMeanSquareVoltage.mean.y_last,pulse2m.fire_n[3],pulse2m.fire_n[2],pulse2m.fire_n[1],pulse2m.fire_p[3],pulse2m.fire_p[2],pulse2m.fire_p[1],pulse2m.twomPulse.timerNegative[3].entryTime,$PRE.pulse2m.twomPulse.timerNegative[3].entryTime,pulse2m.twomPulse.timerNegative[2].entryTime,$PRE.pulse2m.twomPulse.timerNegative[2].entryTime,pulse2m.twomPulse.timerNegative[1].entryTime,$PRE.pulse2m.twomPulse.timerNegative[1].entryTime,pulse2m.twomPulse.timerPositive[3].entryTime,$PRE.pulse2m.twomPulse.timerPositive[3].entryTime,pulse2m.twomPulse.timerPositive[2].entryTime,$PRE.pulse2m.twomPulse.timerPositive[2].entryTime,pulse2m.twomPulse.timerPositive[1].entryTime,$PRE.pulse2m.twomPulse.timerPositive[1].entryTime,pulse2m.twomPulse.negativeThreshold[3].y,pulse2m.twomPulse.negativeThreshold[2].y,pulse2m.twomPulse.negativeThreshold[1].y,pulse2m.twomPulse.positiveThreshold[3].y,pulse2m.twomPulse.positiveThreshold[2].y,pulse2m.twomPulse.positiveThreshold[1].y,rectifier.pre[3].y,rectifier.pre[3].u,$PRE.rectifier.pre[3].u,rectifier.pre[2].y,rectifier.pre[2].u,$PRE.rectifier.pre[2].u,rectifier.pre[1].y,rectifier.pre[1].u,$PRE.rectifier.pre[1].u,rectifier.diode_n.idealDiode[3].off,rectifier.diode_n.idealDiode[2].off,rectifier.diode_n.idealDiode[1].off,rectifier.thyristor_p.idealThyristor[3].off,$PRE.rectifier.thyristor_p.idealThyristor[3].off,rectifier.thyristor_p.idealThyristor[2].off,$PRE.rectifier.thyristor_p.idealThyristor[2].off,rectifier.thyristor_p.idealThyristor[1].off,$PRE.rectifier.thyristor_p.idealThyristor[1].off,$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 (138):
 * Single equations (assignments): 137
 * Array equations: 0
 * Algorithm blocks: 0
 * Record equations: 0
 * When equations: 0
 * If-equations: 0
 * Equation systems (not torn): 0
 * Torn equation systems: 1
 * Mixed (continuous/discrete) equation systems: 0
Notification: Torn system details for strict tearing set:
 * Linear torn systems (#iteration vars, #inner vars, density): 0 systems
 * Non-linear torn systems (#iteration vars, #inner vars): 1 system
   {(6,36)}
Notification: Performance of prepare postOptimizeDAE: time 0.0004288/0.4341, allocations: 316 kB / 0.608 GB, free: 2.23 MB / 462.1 MB
Notification: Performance of postOpt lateInlineFunction (simulation): time 0.000326/0.4344, allocations: 146.2 kB / 0.6082 GB, free: 2.086 MB / 462.1 MB
Notification: Performance of postOpt wrapFunctionCalls (simulation): time 0.0004598/0.4349, allocations: 190.9 kB / 0.6083 GB, free: 1.891 MB / 462.1 MB
Notification: Performance of postOpt simplifysemiLinear (simulation): time 1.126e-05/0.4349, allocations: 3.984 kB / 0.6083 GB, free: 1.887 MB / 462.1 MB
Notification: Performance of postOpt simplifyComplexFunction (simulation): time 4.819e-06/0.4349, allocations: 3.984 kB / 0.6083 GB, free: 1.883 MB / 462.1 MB
Notification: Performance of postOpt removeConstants (simulation): time 0.0006731/0.4356, allocations: 410.9 kB / 0.6087 GB, free: 1.461 MB / 462.1 MB
Notification: Performance of postOpt simplifyTimeIndepFuncCalls (simulation): time 0.000236/0.4358, allocations: 35.98 kB / 0.6088 GB, free: 1.426 MB / 462.1 MB
Notification: Performance of postOpt simplifyAllExpressions (simulation): time 0.0007437/0.4366, allocations: 99.89 kB / 0.6089 GB, free: 1.328 MB / 462.1 MB
Notification: Performance of postOpt findZeroCrossings (simulation): time 0.0002982/0.4369, allocations: 133.1 kB / 0.609 GB, free: 1.199 MB / 462.1 MB
Notification: Performance of postOpt createDAEmodeBDAE (simulation): time 0.004226/0.4411, allocations: 2.239 MB / 0.6112 GB, free: 14.94 MB / 478.1 MB
Notification: Performance of postOpt symbolicJacobianDAE (simulation): time 0.003816/0.4449, allocations: 2.694 MB / 0.6138 GB, free: 12.23 MB / 478.1 MB
Notification: Performance of postOpt setEvaluationStage (simulation): time 0.001071/0.446, allocations: 0.7909 MB / 0.6146 GB, free: 11.45 MB / 478.1 MB
Notification: Performance of sorting global known variables: time 0.001353/0.4474, allocations: 0.9166 MB / 0.6155 GB, free: 10.52 MB / 478.1 MB
Notification: Performance of Backend: time 3.01e-07/0.4474, allocations: 0 / 0.6155 GB, free: 10.52 MB / 478.1 MB
Notification: Performance of simCode: created initialization part: time 0.005193/0.4526, allocations: 2.89 MB / 0.6183 GB, free: 7.605 MB / 478.1 MB
Notification: Performance of SimCode: time 0.006743/0.4594, allocations: 4.252 MB / 0.6224 GB, free: 3.305 MB / 478.1 MB
Notification: Performance of Templates: time 0.06186/0.5212, allocations: 37.78 MB / 0.6593 GB, free: 13.74 MB / 0.5138 GB
make -j1 -f ModelicaTest_trunk_ModelicaTest.Electrical.PowerConverters.HalfControlledBridge2mPulse.makefile
(rm -f ModelicaTest_trunk_ModelicaTest.Electrical.PowerConverters.HalfControlledBridge2mPulse.pipe ; mkfifo ModelicaTest_trunk_ModelicaTest.Electrical.PowerConverters.HalfControlledBridge2mPulse.pipe ; head -c 1048576 < ModelicaTest_trunk_ModelicaTest.Electrical.PowerConverters.HalfControlledBridge2mPulse.pipe >> ../files/ModelicaTest_trunk_ModelicaTest.Electrical.PowerConverters.HalfControlledBridge2mPulse.sim & ./ModelicaTest_trunk_ModelicaTest.Electrical.PowerConverters.HalfControlledBridge2mPulse  -abortSlowSimulation -alarm=480  -emit_protected -lv LOG_STATS > ModelicaTest_trunk_ModelicaTest.Electrical.PowerConverters.HalfControlledBridge2mPulse.pipe 2>&1)