Execution Chart

We display below the execution chart for this examination (boot time has been removed).

Trace from the execution

Waiting for the VM to be ready (probing ssh)
..................
/home/mcc/execution
total 892K
-rw-r--r-- 1 mcc users 3.9K May 15 18:54 CTLCardinality.txt
-rw-r--r-- 1 mcc users 22K May 15 18:54 CTLCardinality.xml
-rw-r--r-- 1 mcc users 2.6K May 15 18:54 CTLFireability.txt
-rw-r--r-- 1 mcc users 17K May 15 18:54 CTLFireability.xml
-rw-r--r-- 1 mcc users 4.0K May 15 18:50 GenericPropertiesDefinition.xml
-rw-r--r-- 1 mcc users 6.1K May 15 18:50 GenericPropertiesVerdict.xml
-rw-r--r-- 1 mcc users 2.4K May 15 18:54 LTLCardinality.txt
-rw-r--r-- 1 mcc users 10K May 15 18:54 LTLCardinality.xml
-rw-r--r-- 1 mcc users 2.0K May 15 18:54 LTLFireability.txt
-rw-r--r-- 1 mcc users 9.6K May 15 18:54 LTLFireability.xml
-rw-r--r-- 1 mcc users 3.3K May 15 18:54 ReachabilityCardinality.txt
-rw-r--r-- 1 mcc users 16K May 15 18:54 ReachabilityCardinality.xml
-rw-r--r-- 1 mcc users 113 May 15 18:54 ReachabilityDeadlock.txt
-rw-r--r-- 1 mcc users 351 May 15 18:54 ReachabilityDeadlock.xml
-rw-r--r-- 1 mcc users 2.5K May 15 18:54 ReachabilityFireability.txt
-rw-r--r-- 1 mcc users 13K May 15 18:54 ReachabilityFireability.xml
-rw-r--r-- 1 mcc users 1.7K May 15 18:54 UpperBounds.txt
-rw-r--r-- 1 mcc users 3.7K May 15 18:54 UpperBounds.xml
-rw-r--r-- 1 mcc users 6 May 15 18:50 equiv_col
-rw-r--r-- 1 mcc users 4 May 15 18:50 instance
-rw-r--r-- 1 mcc users 6 May 15 18:50 iscolored
-rw-r--r-- 1 mcc users 726K May 15 18:50 model.pnml
=====================================================================
Generated by BenchKit 2-3637
Executing tool itstools
Input is FlexibleBarrier-PT-14b, examination is ReachabilityDeadlock
Time confinement is 3600 seconds
Memory confinement is 16384 MBytes
Number of cores is 4
Run identifier is r092-blw7-152650004400181
=====================================================================

--------------------
content from stdout:

=== Data for post analysis generated by BenchKit (invocation template)

The expected result is a vector of booleans
BOOL_VECTOR

here is the order used to build the result vector(from text file)
FORMULA_NAME FlexibleBarrier-PT-14b-ReachabilityDeadlock-0

=== Now, execution of the tool begins

BK_START 1527265215878

Flatten gal took : 439 ms
Constant places removed 1 places and 1 transitions.
Performed 1767 Post agglomeration using F-continuation condition.
Iterating post reduction 0 with 1768 rules applied. Total rules applied 1768 place count 2677 transition count 1317
Constant places removed 1769 places and 2 transitions.
Reduce isomorphic transitions removed 1 transitions.
Iterating post reduction 1 with 1770 rules applied. Total rules applied 3538 place count 908 transition count 1314
Performed 1 Pre agglomeration using Quasi-Persistent + HF-interchangeable + Divergent Free condition.
Pre-agglomeration after 2 with 1 Pre rules applied. Total rules applied 3538 place count 908 transition count 1313
Constant places removed 1 places and 0 transitions.
Iterating post reduction 2 with 1 rules applied. Total rules applied 3539 place count 907 transition count 1313
Symmetric choice reduction at 3 with 343 rule applications. Total rules 3882 place count 907 transition count 1313
Constant places removed 343 places and 343 transitions.
Reduce isomorphic transitions removed 169 transitions.
Iterating post reduction 3 with 512 rules applied. Total rules applied 4394 place count 564 transition count 801
Performed 71 Post agglomeration using F-continuation condition.
Constant places removed 71 places and 0 transitions.
Iterating post reduction 4 with 71 rules applied. Total rules applied 4465 place count 493 transition count 730
Performed 28 Post agglomeration using F-continuation condition.
Constant places removed 28 places and 0 transitions.
Iterating post reduction 5 with 28 rules applied. Total rules applied 4493 place count 465 transition count 872
Applied a total of 4493 rules in 824 ms. Remains 465 /2678 variables (removed 2213) and now considering 872/3085 (removed 2213) transitions.
Normalized transition count is 830
// Phase 1: matrix 830 rows 465 cols
Using solver Z3 to compute partial order matrices.
Built C files in :
/home/mcc/execution
Invoking ITS tools like this :CommandLine [args=[/home/mcc/BenchKit/itstools/plugins/fr.lip6.move.gal.itstools.binaries_1.0.0.201805151631/bin/its-ctl-linux64, --gc-threshold, 2000000, --quiet, -i, /home/mcc/execution/ReachabilityDeadlock.pnml.gal, -t, CGAL, -ctl, DEADLOCK], workingDir=/home/mcc/execution]

its-ctl command run as :

/home/mcc/BenchKit/itstools/plugins/fr.lip6.move.gal.itstools.binaries_1.0.0.201805151631/bin/its-ctl-linux64 --gc-threshold 2000000 --quiet -i /home/mcc/execution/ReachabilityDeadlock.pnml.gal -t CGAL -ctl DEADLOCK
No direction supplied, using forward translation only.
Presburger conditions satisfied. Using coverability to approximate state space in K-Induction.
Normalized transition count is 830
// Phase 1: matrix 830 rows 465 cols
invariant :p1123 + p1127 + p1131 + p1135 + p1139 + p1143 + p1147 + p1151 + p1155 + p1159 + p1163 + p1167 + p1174 + p1180 + p1181 + p1183 + p1184 + p1187 + p1193 + p1198 + p1200 = 1
invariant :p67 + p71 + p75 + p79 + p83 + p87 + p91 + p95 + p99 + p103 + p107 + p111 + p118 + p124 + p125 + p127 + p128 + p131 + p137 + p142 + p144 = 1
invariant :p991 + p995 + p999 + p1003 + p1007 + p1011 + p1015 + p1019 + p1023 + p1027 + p1031 + p1035 + p1042 + p1048 + p1049 + p1051 + p1052 + p1055 + p1061 + p1066 + p1068 = 1
invariant :p1651 + p1655 + p1659 + p1663 + p1667 + p1671 + p1675 + p1679 + p1683 + p1687 + p1691 + p1695 + p1702 + p1708 + p1709 + p1711 + p1712 + p1715 + p1721 + p1726 + p1728 = 1
invariant :p1387 + p1391 + p1395 + p1399 + p1403 + p1407 + p1411 + p1415 + p1419 + p1423 + p1427 + p1431 + p1438 + p1444 + p1445 + p1447 + p1448 + p1451 + p1457 + p1462 + p1464 = 1
invariant :p727 + p731 + p735 + p739 + p743 + p747 + p751 + p755 + p759 + p763 + p767 + p771 + p778 + p784 + p785 + p787 + p788 + p791 + p797 + p802 + p804 = 1
invariant :p1733 + p1737 + p1741 + p1745 + p1749 + p1753 + p1757 + p1761 + p1765 + p1769 + p1773 + p1777 + p1781 + p1788 + p1794 + p1795 + p1797 + p1798 + p1801 + p1810 = 1
invariant :p2674 + p2675 = 1
invariant :p199 + p203 + p207 + p211 + p215 + p219 + p223 + p227 + p231 + p235 + p239 + p243 + p250 + p256 + p257 + p259 + p260 + p263 + p269 + p274 + p276 = 1
invariant :p463 + p467 + p471 + p475 + p479 + p483 + p487 + p491 + p495 + p499 + p503 + p507 + p514 + p520 + p521 + p523 + p524 + p527 + p533 + p538 + p540 = 1
invariant :p1519 + p1523 + p1527 + p1531 + p1535 + p1539 + p1543 + p1547 + p1551 + p1555 + p1559 + p1563 + p1570 + p1576 + p1577 + p1579 + p1580 + p1583 + p1589 + p1594 + p1596 = 1
invariant :p859 + p863 + p867 + p871 + p875 + p879 + p883 + p887 + p891 + p895 + p899 + p903 + p910 + p916 + p917 + p919 + p920 + p923 + p929 + p934 + p936 = 1
invariant :p1819 + p1824 + p1829 + p1834 + p1839 + p1844 + p1849 + p1854 + p1859 + p1864 + p1869 + p1874 + p1879 + p1884 + p1889 + p1894 + p1899 + p1904 + p1909 + p1914 + p1919 + p1924 + p1929 + p1934 + p1939 + p1944 + p1949 + p1954 + p1959 + p1964 + p1969 + p1974 + p1979 + p1984 + p1989 + p1994 + p1999 + p2004 + p2009 + p2014 + p2019 + p2024 + p2029 + p2034 + p2039 + p2044 + p2049 + p2054 + p2059 + p2064 + p2069 + p2074 + p2079 + p2084 + p2089 + p2094 + p2099 + p2104 + p2109 + p2114 + p2119 + p2124 + p2129 + p2134 + p2139 + p2144 + p2149 + p2154 + p2159 + p2164 + p2169 + p2174 + p2179 + p2184 + p2189 + p2194 + p2199 + p2204 + p2209 + p2214 + p2219 + p2224 + p2229 + p2234 + p2239 + p2244 + p2249 + p2254 + p2259 + p2264 + p2269 + p2274 + p2279 + p2284 + p2289 + p2294 + p2299 + p2304 + p2309 + p2314 + p2319 + p2324 + p2329 + p2334 + p2339 + p2344 + p2349 + p2354 + p2359 + p2364 + p2369 + p2374 + p2379 + p2384 + p2389 + p2394 + p2399 + p2404 + p2409 + p2414 + p2419 + p2424 + p2429 + p2434 + p2439 + p2444 + p2449 + p2454 + p2459 + p2464 + p2469 + p2474 + p2479 + p2484 + p2489 + p2494 + p2499 + p2504 + p2509 + p2514 + p2519 + p2524 + p2529 + p2534 + p2539 + p2544 + p2549 + p2554 + p2559 + p2564 + p2569 + p2574 + p2579 + p2584 + p2589 + p2594 + p2599 + p2604 + p2609 + p2614 + p2619 + p2624 + p2629 + p2634 + p2639 + p2644 + p2649 + p2654 + p2659 + p2663 = 1
invariant :p331 + p335 + p339 + p343 + p347 + p351 + p355 + p359 + p363 + p367 + p371 + p375 + p382 + p388 + p389 + p391 + p392 + p395 + p401 + p406 + p408 = 1
invariant :p595 + p599 + p603 + p607 + p611 + p615 + p619 + p623 + p627 + p631 + p635 + p639 + p646 + p652 + p653 + p655 + p656 + p659 + p665 + p670 + p672 = 1
invariant :p1255 + p1259 + p1263 + p1267 + p1271 + p1275 + p1279 + p1283 + p1287 + p1291 + p1295 + p1299 + p1306 + p1312 + p1313 + p1315 + p1316 + p1319 + p1325 + p1330 + p1332 = 1
Running compilation step : CommandLine [args=[gcc, -c, -I/home/mcc/BenchKit//lts_install_dir//include, -I., -std=c99, -fPIC, -O3, model.c], workingDir=/home/mcc/execution]
sparsehash FATAL ERROR: failed to allocate 34 groups
WARNING : LTS min runner thread failed on error :java.lang.RuntimeException: Could not compile executable .CommandLine [args=[gcc, -c, -I/home/mcc/BenchKit//lts_install_dir//include, -I., -std=c99, -fPIC, -O3, model.c], workingDir=/home/mcc/execution]

BK_STOP 1527265833676

--------------------
content from stderr:

+ export BINDIR=/home/mcc/BenchKit/
+ BINDIR=/home/mcc/BenchKit/
++ pwd
+ export MODEL=/home/mcc/execution
+ MODEL=/home/mcc/execution
+ /home/mcc/BenchKit//runeclipse.sh /home/mcc/execution ReachabilityDeadlock -its -ltsminpath /home/mcc/BenchKit//lts_install_dir/ -smt
+ ulimit -s 65536
+ [[ -z '' ]]
+ export LTSMIN_MEM_SIZE=8589934592
+ LTSMIN_MEM_SIZE=8589934592
+ /home/mcc/BenchKit//itstools/its-tools -consoleLog -data /home/mcc/execution/workspace -pnfolder /home/mcc/execution -examination ReachabilityDeadlock -z3path /home/mcc/BenchKit//z3/bin/z3 -yices2path /home/mcc/BenchKit//yices/bin/yices -its -ltsminpath /home/mcc/BenchKit//lts_install_dir/ -smt -vmargs -Dosgi.locking=none -Declipse.stateSaveDelayInterval=-1 -Dosgi.configuration.area=/tmp/.eclipse -Xss8m -Xms40m -Xmx8192m -Dfile.encoding=UTF-8 -Dosgi.requiredJavaVersion=1.6
May 25, 2018 4:20:17 PM fr.lip6.move.gal.application.Application start
INFO: Running its-tools with arguments : [-pnfolder, /home/mcc/execution, -examination, ReachabilityDeadlock, -z3path, /home/mcc/BenchKit//z3/bin/z3, -yices2path, /home/mcc/BenchKit//yices/bin/yices, -its, -ltsminpath, /home/mcc/BenchKit//lts_install_dir/, -smt]
May 25, 2018 4:20:17 PM fr.lip6.move.gal.application.MccTranslator transformPNML
INFO: Parsing pnml file : /home/mcc/execution/model.pnml
May 25, 2018 4:20:17 PM fr.lip6.move.gal.nupn.PTNetReader loadFromXML
INFO: Load time of PNML (sax parser for PT used): 179 ms
May 25, 2018 4:20:17 PM fr.lip6.move.gal.pnml.togal.PTGALTransformer handlePage
INFO: Transformed 2678 places.
May 25, 2018 4:20:17 PM fr.lip6.move.gal.pnml.togal.PTGALTransformer handlePage
INFO: Transformed 3085 transitions.
May 25, 2018 4:20:17 PM fr.lip6.move.gal.pnml.togal.PnmlToGalTransformer transform
INFO: Found NUPN structural information;
May 25, 2018 4:20:17 PM fr.lip6.move.serialization.SerializationUtil systemToFile
INFO: Time to serialize gal into /home/mcc/execution/model.pnml.img.gal : 51 ms
May 25, 2018 4:20:18 PM fr.lip6.move.gal.instantiate.GALRewriter flatten
INFO: Flatten gal took : 436 ms
May 25, 2018 4:20:18 PM fr.lip6.move.serialization.SerializationUtil systemToFile
INFO: Time to serialize gal into /home/mcc/execution/model.pnml.simple.gal : 12 ms
May 25, 2018 4:20:18 PM fr.lip6.move.gal.semantics.DeterministicNextBuilder getDeterministicNext
INFO: Input system was already deterministic with 3085 transitions.
May 25, 2018 4:20:19 PM fr.lip6.move.serialization.SerializationUtil systemToFile
INFO: Time to serialize gal into /home/mcc/execution/ReachabilityDeadlock.pnml.gal : 4 ms
May 25, 2018 4:20:19 PM fr.lip6.move.gal.semantics.DeterministicNextBuilder getDeterministicNext
INFO: Input system was already deterministic with 872 transitions.
May 25, 2018 4:20:20 PM fr.lip6.move.gal.gal2smt.bmc.KInductionSolver computeAndDeclareInvariants
INFO: Computed 16 place invariants in 90 ms
May 25, 2018 4:20:21 PM fr.lip6.move.gal.gal2smt.bmc.KInductionSolver init
INFO: Proved 465 variables to be positive in 1009 ms
May 25, 2018 4:20:21 PM fr.lip6.move.gal.gal2smt.bmc.NecessaryEnablingsolver computeAblingMatrix
INFO: Computing symmetric may disable matrix : 872 transitions.
May 25, 2018 4:20:21 PM fr.lip6.move.gal.gal2smt.bmc.NecessaryEnablingsolver printStats
INFO: Computation of disable matrix completed :0/872 took 1 ms. Total solver calls (SAT/UNSAT): 0(0/0)
May 25, 2018 4:20:21 PM fr.lip6.move.gal.gal2smt.bmc.NecessaryEnablingsolver printStats
INFO: Computation of Complete disable matrix. took 93 ms. Total solver calls (SAT/UNSAT): 0(0/0)
May 25, 2018 4:20:21 PM fr.lip6.move.gal.gal2smt.bmc.NecessaryEnablingsolver computeAblingMatrix
INFO: Computing symmetric may enable matrix : 872 transitions.
May 25, 2018 4:20:21 PM fr.lip6.move.gal.gal2smt.bmc.NecessaryEnablingsolver printStats
INFO: Computation of Complete enable matrix. took 63 ms. Total solver calls (SAT/UNSAT): 0(0/0)
May 25, 2018 4:20:21 PM fr.lip6.move.gal.gal2smt.bmc.NecessaryEnablingsolver computeCoEnablingMatrix
INFO: Computing symmetric co enabling matrix : 872 transitions.
May 25, 2018 4:23:20 PM fr.lip6.move.gal.gal2smt.bmc.NecessaryEnablingsolver printStats
INFO: Computation of co-enabling matrix(1/872) took 179444 ms. Total solver calls (SAT/UNSAT): 647(294/353)
May 25, 2018 4:26:19 PM fr.lip6.move.gal.gal2smt.bmc.NecessaryEnablingsolver printStats
INFO: Computation of co-enabling matrix(2/872) took 357731 ms. Total solver calls (SAT/UNSAT): 1195(517/678)
May 25, 2018 4:29:18 PM fr.lip6.move.gal.gal2smt.bmc.NecessaryEnablingsolver printStats
INFO: Computation of co-enabling matrix(3/872) took 537574 ms. Total solver calls (SAT/UNSAT): 1742(739/1003)
Skipping mayMatrices nes/nds SMT solver raised an exception or timeout.
java.lang.RuntimeException: SMT solver raised an exception or timeout.
at fr.lip6.move.gal.gal2smt.bmc.NecessaryEnablingsolver.computeCoEnablingMatrix(NecessaryEnablingsolver.java:480)
at fr.lip6.move.gal.gal2pins.Gal2PinsTransformerNext.printLabels(Gal2PinsTransformerNext.java:530)
at fr.lip6.move.gal.gal2pins.Gal2PinsTransformerNext.printDependencyMatrix(Gal2PinsTransformerNext.java:209)
at fr.lip6.move.gal.gal2pins.Gal2PinsTransformerNext.buildBodyFile(Gal2PinsTransformerNext.java:85)
at fr.lip6.move.gal.gal2pins.Gal2PinsTransformerNext.transform(Gal2PinsTransformerNext.java:830)
at fr.lip6.move.gal.application.LTSminRunner$1.run(LTSminRunner.java:71)
at java.lang.Thread.run(Thread.java:748)
May 25, 2018 4:30:27 PM fr.lip6.move.gal.gal2pins.Gal2PinsTransformerNext transform
INFO: Built C files in 608013ms conformant to PINS in folder :/home/mcc/execution
virtual memory exhausted: Cannot allocate memory
java.lang.RuntimeException: Could not compile executable .CommandLine [args=[gcc, -c, -I/home/mcc/BenchKit//lts_install_dir//include, -I., -std=c99, -fPIC, -O3, model.c], workingDir=/home/mcc/execution]
at fr.lip6.move.gal.application.LTSminRunner.compilePINS(LTSminRunner.java:241)
at fr.lip6.move.gal.application.LTSminRunner.access$6(LTSminRunner.java:224)
at fr.lip6.move.gal.application.LTSminRunner$1.run(LTSminRunner.java:75)
at java.lang.Thread.run(Thread.java:748)
ITS-tools command line returned an error code 1

Sequence of Actions to be Executed by the VM

This is useful if one wants to reexecute the tool in the VM from the submitted image disk.

set -x
# this is for BenchKit: configuration of major elements for the test
export BK_INPUT="FlexibleBarrier-PT-14b"
export BK_EXAMINATION="ReachabilityDeadlock"
export BK_TOOL="itstools"
export BK_RESULT_DIR="/tmp/BK_RESULTS/OUTPUTS"
export BK_TIME_CONFINEMENT="3600"
export BK_MEMORY_CONFINEMENT="16384"

# this is specific to your benchmark or test

export BIN_DIR="$HOME/BenchKit/bin"

# remove the execution directoty if it exists (to avoid increse of .vmdk images)
if [ -d execution ] ; then
rm -rf execution
fi

tar xzf /home/mcc/BenchKit/INPUTS/FlexibleBarrier-PT-14b.tgz
mv FlexibleBarrier-PT-14b execution
cd execution
pwd
ls -lh

# this is for BenchKit: explicit launching of the test
echo "====================================================================="
echo " Generated by BenchKit 2-3637"
echo " Executing tool itstools"
echo " Input is FlexibleBarrier-PT-14b, examination is ReachabilityDeadlock"
echo " Time confinement is $BK_TIME_CONFINEMENT seconds"
echo " Memory confinement is 16384 MBytes"
echo " Number of cores is 4"
echo " Run identifier is r092-blw7-152650004400181"
echo "====================================================================="
echo
echo "--------------------"
echo "content from stdout:"
echo
echo "=== Data for post analysis generated by BenchKit (invocation template)"
echo
if [ "ReachabilityDeadlock" = "UpperBounds" ] ; then
echo "The expected result is a vector of positive values"
echo NUM_VECTOR
elif [ "ReachabilityDeadlock" != "StateSpace" ] ; then
echo "The expected result is a vector of booleans"
echo BOOL_VECTOR
else
echo "no data necessary for post analysis"
fi
echo
if [ -f "ReachabilityDeadlock.txt" ] ; then
echo "here is the order used to build the result vector(from text file)"
for x in $(grep Property ReachabilityDeadlock.txt | cut -d ' ' -f 2 | sort -u) ; do
echo "FORMULA_NAME $x"
done
elif [ -f "ReachabilityDeadlock.xml" ] ; then # for cunf (txt files deleted;-)
echo echo "here is the order used to build the result vector(from xml file)"
for x in $(grep '' ReachabilityDeadlock.xml | cut -d '>' -f 2 | cut -d '<' -f 1 | sort -u) ; do
echo "FORMULA_NAME $x"
done
fi
echo
echo "=== Now, execution of the tool begins"
echo
echo -n "BK_START "
date -u +%s%3N
echo
timeout -s 9 $BK_TIME_CONFINEMENT bash -c "/home/mcc/BenchKit/BenchKit_head.sh 2> STDERR ; echo ; echo -n \"BK_STOP \" ; date -u +%s%3N"
if [ $? -eq 137 ] ; then
echo
echo "BK_TIME_CONFINEMENT_REACHED"
fi
echo
echo "--------------------"
echo "content from stderr:"
echo
cat STDERR ;