Running: ./testmodel.py --libraries=/home/hudson/saved_omc/libraries/.openmodelica/libraries --ompython_omhome=/usr Modelica_trunk_Modelica.Electrical.Analog.Examples.NandGate.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)
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(Modelica.Electrical.Analog.Examples.NandGate,tolerance=1e-06,outputFormat="mat",numberOfIntervals=5000,variableFilter="time|Nand.C4.v|Nand.C7.v",fileNamePrefix="Modelica_trunk_Modelica.Electrical.Analog.Examples.NandGate")
translateModel(Modelica.Electrical.Analog.Examples.NandGate,tolerance=1e-06,outputFormat="mat",numberOfIntervals=5000,variableFilter="time|Nand.C4.v|Nand.C7.v",fileNamePrefix="Modelica_trunk_Modelica.Electrical.Analog.Examples.NandGate")
Notification: Performance of loadFile(/home/hudson/saved_omc/libraries/.openmodelica/libraries/ModelicaServices trunk/package.mo): time 0.001205/0.001205, allocations: 115.2 kB / 18.47 MB, free: 4.609 MB / 14.72 MB
Notification: Performance of loadFile(/home/hudson/saved_omc/libraries/.openmodelica/libraries/Complex trunk/package.mo): time 0.001333/0.001333, allocations: 213 kB / 19.42 MB, free: 3.66 MB / 14.72 MB
Notification: Performance of loadFile(/home/hudson/saved_omc/libraries/.openmodelica/libraries/Modelica trunk/package.mo): time 1.301/1.301, allocations: 227.4 MB / 247.6 MB, free: 10.48 MB / 206.1 MB
Notification: Performance of FrontEnd - Absyn->SCode: time 2.673e-05/2.675e-05, allocations: 2.281 kB / 359.3 MB, free: 12.99 MB / 302.1 MB
Notification: Performance of NFInst.instantiate(Modelica.Electrical.Analog.Examples.NandGate): time 0.005781/0.005817, allocations: 4.27 MB / 363.6 MB, free: 8.695 MB / 302.1 MB
Notification: Performance of NFInst.instExpressions: time 0.002752/0.008592, allocations: 1.207 MB / 364.8 MB, free: 7.48 MB / 302.1 MB
Notification: Performance of NFInst.updateImplicitVariability: time 0.0006487/0.009258, allocations: 8 kB / 364.8 MB, free: 7.473 MB / 302.1 MB
Notification: Performance of NFTyping.typeComponents: time 0.000415/0.009685, allocations: 110.8 kB / 364.9 MB, free: 7.363 MB / 302.1 MB
Notification: Performance of NFTyping.typeBindings: time 0.0006749/0.01041, allocations: 182.3 kB / 365.1 MB, free: 7.184 MB / 302.1 MB
Notification: Performance of NFTyping.typeClassSections: time 0.0008674/0.01129, allocations: 331.5 kB / 365.4 MB, free: 6.859 MB / 302.1 MB
Notification: Performance of NFFlatten.flatten: time 0.001497/0.0128, allocations: 1.214 MB / 366.6 MB, free: 5.641 MB / 302.1 MB
Notification: Performance of NFFlatten.resolveConnections: time 0.000521/0.01333, allocations: 283.1 kB / 366.9 MB, free: 5.355 MB / 302.1 MB
Notification: Performance of NFEvalConstants.evaluate: time 0.0007792/0.01412, allocations: 410.7 kB / 367.3 MB, free: 4.953 MB / 302.1 MB
Notification: Performance of NFSimplifyModel.simplify: time 0.0007745/0.01491, allocations: 458.3 kB / 367.8 MB, free: 4.504 MB / 302.1 MB
Notification: Performance of NFPackage.collectConstants: time 0.0003647/0.01528, allocations: 120 kB / 367.9 MB, free: 4.387 MB / 302.1 MB
Notification: Performance of NFFlatten.collectFunctions: time 0.0003638/0.01566, allocations: 116 kB / 368 MB, free: 4.273 MB / 302.1 MB
Notification: Performance of combineBinaries: time 0.001413/0.01708, allocations: 1.295 MB / 369.3 MB, free: 2.965 MB / 302.1 MB
Notification: Performance of replaceArrayConstructors: time 0.0007736/0.01786, allocations: 0.7388 MB / 370 MB, free: 2.215 MB / 302.1 MB
Notification: Performance of NFVerifyModel.verify: time 0.0005278/0.0184, allocations: 147.6 kB / 370.2 MB, free: 2.07 MB / 302.1 MB
Notification: Performance of FrontEnd: time 0.0002802/0.01869, allocations: 20 kB / 370.2 MB, free: 2.051 MB / 302.1 MB
Notification: Model statistics after passing the front-end and creating the data structures used by the back-end:
 * Number of equations: 147 (147)
 * Number of variables: 147 (147)
Notification: Performance of Bindings: time 0.1647/0.1834, allocations: 3.918 MB / 374.1 MB, free: 14.92 MB / 302.1 MB
Notification: Performance of FunctionAlias: time 0.0001691/0.1836, allocations: 193.8 kB / 374.3 MB, free: 14.92 MB / 302.1 MB
Notification: Performance of Early Inline: time 0.002119/0.1857, allocations: 2.32 MB / 376.6 MB, free: 13.77 MB / 302.1 MB
Notification: Performance of simplify1: time 0.0003628/0.1861, allocations: 205.3 kB / 376.8 MB, free: 13.69 MB / 302.1 MB
Notification: Performance of Alias: time 0.003943/0.19, allocations: 3.782 MB / 380.6 MB, free: 11.47 MB / 302.1 MB
Notification: Performance of simplify2: time 0.0001753/0.1902, allocations: 145.8 kB / 380.7 MB, free: 11.42 MB / 302.1 MB
Notification: Performance of Detect States: time 0.000522/0.1907, allocations: 0.5249 MB / 381.3 MB, free: 11.08 MB / 302.1 MB
Notification: Performance of Events: time 0.0007239/0.1915, allocations: 0.5368 MB / 381.8 MB, free: 10.83 MB / 302.1 MB
Notification: Performance of Partitioning: time 0.0007379/0.1922, allocations: 0.7857 MB / 382.6 MB, free: 10.28 MB / 302.1 MB
Notification: Performance of Causalize: time 0.003289/0.1955, allocations: 3.054 MB / 385.7 MB, free: 9.102 MB / 302.1 MB
Notification: Performance of After Index Reduction Inline: time 0.001651/0.1972, allocations: 1.915 MB / 387.6 MB, free: 7.938 MB / 302.1 MB
Notification: Performance of Inline: time 0.002773/0.2, allocations: 3.138 MB / 390.7 MB, free: 6.039 MB / 302.1 MB
Notification: Performance of Partitioning: time 0.0001558/0.2001, allocations: 155.2 kB / 390.9 MB, free: 5.934 MB / 302.1 MB
Notification: Performance of Cleanup: time 0.0001127/0.2003, allocations: 149.8 kB / 391 MB, free: 5.844 MB / 302.1 MB
Notification: Performance of Causalize: time 0.005407/0.2057, allocations: 4.399 MB / 395.4 MB, free: 4.258 MB / 302.1 MB
Notification: Performance of Tearing: time 2.029e-05/0.2057, allocations: 0 / 395.4 MB, free: 4.258 MB / 302.1 MB
Notification: Performance of Initialization: time 1.212e-06/0.2057, allocations: 0 / 395.4 MB, free: 4.258 MB / 302.1 MB
Notification: Performance of Tearing: time 2.711e-05/0.2057, allocations: 7 kB / 395.4 MB, free: 4.254 MB / 302.1 MB
Notification: Performance of Categorize: time 4.106e-05/0.2058, allocations: 11.03 kB / 395.4 MB, free: 4.246 MB / 302.1 MB
Notification: Performance of Solve: time 0.000824/0.2066, allocations: 480.2 kB / 395.9 MB, free: 4.105 MB / 302.1 MB
Notification: Performance of Jacobian: time 0.0007097/0.2073, allocations: 0.9342 MB / 396.8 MB, free: 3.59 MB / 302.1 MB
Notification: Partition statistics after passing the back-end:
 * Number of ODE partitions: ..................... 0
 * Number of algebraic partitions: ............... 2
 * Number of ODE event partitions: ............... 1
 * Number of algebraic event partitions: ......... 12
 * Number of clocked partitions: ................. 0
 * Number of initial partitions: ................. 1
 * Number of initial(lambda=0) partitions: ....... 0
Notification: Variable statistics after passing the back-end:
 * Number of states: ............................. 2 (2) {Nand.C4.v, Nand.C7.v}
 * Number of discrete states: .................... 4 (4) {VIN2.signalSource.count, VIN2.signalSource.T_start, VIN1.signalSource.count, VIN1.signalSource.T_start}
 * Number of clocked states: ..................... 0 (0) {NOT YET AVAILABLE}
 * Number of discrete variables: ................. 43 (43) {$SEV_40, $SEV_39, $SEV_38, $SEV_37, $SEV_36, $SEV_35, $SEV_34, $SEV_33, $SEV_32, $SEV_31, $SEV_30, $SEV_29, $SEV_28, $SEV_27, $SEV_26, $SEV_25, $SEV_24, $SEV_23, $SEV_22, $SEV_21, $SEV_20, $SEV_19, $SEV_18, $SEV_17, $SEV_16, $SEV_15, $SEV_14, $SEV_13, $SEV_12, $SEV_11, $SEV_10, $SEV_9, $SEV_8, $SEV_7, $SEV_6, $SEV_5, $SEV_4, $SEV_3, $SEV_2, $SEV_1, $SEV_0, $TEV_1, $TEV_0}
 * Number of top-level inputs: ................... 0 (0) {}
Notification: [Simulation] Strong Component statistics after passing the back-end:
 * Number of single strong components: ........... 103 (scalar:103, array:0, record:0)
 * Number of multi strong components: ............ 4 (algorithm:0, when:4, if:0, tuple:0)
 * Number of for-loop strong components: ......... 0 (generic: 0, entwined:0)
 * Number of algebraic-loop strong components: ... 0 (linear: 0, nonlinear:0)
Notification: [Initialization] Strong Component statistics after passing the back-end:
 * Number of single strong components: ........... 151 (scalar:151, array:0, record:0)
 * Number of multi strong components: ............ 2 (algorithm:2, when:0, if:0, tuple:0)
 * Number of for-loop strong components: ......... 0 (generic: 0, entwined:0)
 * Number of algebraic-loop strong components: ... 0 (linear: 0, nonlinear:0)
Notification: Performance of backend: time 6.426e-05/0.2074, allocations: 59.89 kB / 396.9 MB, free: 3.547 MB / 302.1 MB
Notification: Performance of SimCode: time 0.002082/0.2095, allocations: 3.301 MB / 400.2 MB, free: 0.9609 MB / 302.1 MB
Notification: Performance of Templates: time 0.01162/0.2211, allocations: 7.761 MB / 407.9 MB, free: 9.223 MB / 318.1 MB
make -j1 -f Modelica_trunk_Modelica.Electrical.Analog.Examples.NandGate.makefile
(rm -f Modelica_trunk_Modelica.Electrical.Analog.Examples.NandGate.pipe ; mkfifo Modelica_trunk_Modelica.Electrical.Analog.Examples.NandGate.pipe ; head -c 1048576 < Modelica_trunk_Modelica.Electrical.Analog.Examples.NandGate.pipe >> ../files/Modelica_trunk_Modelica.Electrical.Analog.Examples.NandGate.sim & ./Modelica_trunk_Modelica.Electrical.Analog.Examples.NandGate  -abortSlowSimulation -alarm=480  -emit_protected -lv LOG_STATS > Modelica_trunk_Modelica.Electrical.Analog.Examples.NandGate.pipe 2>&1)
diffSimulationResults("Modelica_trunk_Modelica.Electrical.Analog.Examples.NandGate_res.mat","/var/lib/jenkins/ws/OpenModelicaLibraryTestingWork/Reference-modelica.org/ReferenceResults/MAP-LIB_ReferenceResults/v4.0.0/Modelica/Electrical/Analog/Examples/NandGate/NandGate.csv","/var/lib/jenkins/ws/OpenModelicaLibraryTestingWork/OpenModelicaLibraryTesting/files/Modelica_trunk_Modelica.Electrical.Analog.Examples.NandGate.diff",relTol=0.003,relTolDiffMinMax=0.003,rangeDelta=0.001)
""

Variables in the reference:time,Nand.C4.v,Nand.C7.v

Variables in the result:Gnd1.p.v,Gnd4.p.v,Gnd5.p.v,Nand.C4.C,Nand.C4.n.v,Nand.C4.v,Nand.C7.C,Nand.C7.n.v,Nand.C7.v,Nand.Gnd.p.v,Nand.Gnd2.p.v,Nand.Gnd3.p.v,Nand.Gnd6.p.i,Nand.Gnd6.p.v,Nand.Gnd7.p.i,Nand.Gnd7.p.v,Nand.Gnd8.p.i,Nand.Gnd8.p.v,Nand.TN1.B.i,Nand.TN1.B.v,Nand.TN1.Beta,Nand.TN1.G.i,Nand.TN1.K2,Nand.TN1.K5,Nand.TN1.L,Nand.TN1.RDS,Nand.TN1.T,Nand.TN1.T_heatPort,Nand.TN1.Tnom,Nand.TN1.Vt,Nand.TN1.W,Nand.TN1.beta_t,Nand.TN1.dL,Nand.TN1.dW,Nand.TN1.k2_t,Nand.TN1.kk2,Nand.TN1.kvt,Nand.TN1.vt_t,Nand.TN2.B.i,Nand.TN2.B.v,Nand.TN2.Beta,Nand.TN2.G.i,Nand.TN2.K2,Nand.TN2.K5,Nand.TN2.L,Nand.TN2.RDS,Nand.TN2.S.v,Nand.TN2.T,Nand.TN2.T_heatPort,Nand.TN2.Tnom,Nand.TN2.Vt,Nand.TN2.W,Nand.TN2.beta_t,Nand.TN2.dL,Nand.TN2.dW,Nand.TN2.k2_t,Nand.TN2.kk2,Nand.TN2.kvt,Nand.TN2.vt_t,Nand.TP1.B.i,Nand.TP1.B.v,Nand.TP1.Beta,Nand.TP1.G.i,Nand.TP1.K2,Nand.TP1.K5,Nand.TP1.L,Nand.TP1.RDS,Nand.TP1.T,Nand.TP1.T_heatPort,Nand.TP1.Tnom,Nand.TP1.Vt,Nand.TP1.W,Nand.TP1.beta_t,Nand.TP1.dL,Nand.TP1.dW,Nand.TP1.k2_t,Nand.TP1.kk2,Nand.TP1.kvt,Nand.TP1.vt_t,Nand.TP2.B.i,Nand.TP2.B.v,Nand.TP2.Beta,Nand.TP2.G.i,Nand.TP2.K2,Nand.TP2.K5,Nand.TP2.L,Nand.TP2.RDS,Nand.TP2.T,Nand.TP2.T_heatPort,Nand.TP2.Tnom,Nand.TP2.Vt,Nand.TP2.W,Nand.TP2.beta_t,Nand.TP2.dL,Nand.TP2.dW,Nand.TP2.k2_t,Nand.TP2.kk2,Nand.TP2.kvt,Nand.TP2.vt_t,Nand.y.i,VDD.V,VDD.duration,VDD.n.v,VDD.offset,VDD.signalSource.duration,VDD.signalSource.height,VDD.signalSource.offset,VDD.signalSource.startTime,VDD.startTime,VIN1.V,VIN1.falling,VIN1.n.v,VIN1.nperiod,VIN1.offset,VIN1.period,VIN1.rising,VIN1.signalSource.T_falling,VIN1.signalSource.T_rising,VIN1.signalSource.T_width,VIN1.signalSource.amplitude,VIN1.signalSource.falling,VIN1.signalSource.nperiod,VIN1.signalSource.offset,VIN1.signalSource.period,VIN1.signalSource.rising,VIN1.signalSource.startTime,VIN1.signalSource.width,VIN1.startTime,VIN1.width,VIN2.V,VIN2.falling,VIN2.n.v,VIN2.nperiod,VIN2.offset,VIN2.period,VIN2.rising,VIN2.signalSource.T_falling,VIN2.signalSource.T_rising,VIN2.signalSource.T_width,VIN2.signalSource.amplitude,VIN2.signalSource.falling,VIN2.signalSource.nperiod,VIN2.signalSource.offset,VIN2.signalSource.period,VIN2.signalSource.rising,VIN2.signalSource.startTime,VIN2.signalSource.width,VIN2.startTime,VIN2.width,time