INFO Running translator. INFO translator input: ['/home/pluehne/Documents/ASP/pddl-instances/ipc-2000/domains/blocks-strips-typed/domain.pddl', '/home/pluehne/Documents/ASP/pddl-instances/ipc-2000/domains/blocks-strips-typed/instances/instance-51.pddl'] INFO translator arguments: [] INFO translator time limit: None INFO translator memory limit: None INFO callstring: /home/pluehne/.usr/bin/python /home/wv/bin/linux/64/fast-downward-10997/builds/release64/bin/translate/translate.py /home/pluehne/Documents/ASP/pddl-instances/ipc-2000/domains/blocks-strips-typed/domain.pddl /home/pluehne/Documents/ASP/pddl-instances/ipc-2000/domains/blocks-strips-typed/instances/instance-51.pddl Parsing... Parsing: [0.010s CPU, 0.013s wall-clock] Normalizing task... [0.000s CPU, 0.001s wall-clock] Instantiating... Generating Datalog program... [0.010s CPU, 0.004s wall-clock] Normalizing Datalog program... Normalizing Datalog program: [0.000s CPU, 0.010s wall-clock] Preparing model... [0.010s CPU, 0.009s wall-clock] Generated 21 rules. Computing model... [0.250s CPU, 0.244s wall-clock] 2077 relevant atoms 1375 auxiliary atoms 3452 final queue length 6006 total queue pushes Completing instantiation... [0.420s CPU, 0.419s wall-clock] Instantiating: [0.690s CPU, 0.689s wall-clock] Computing fact groups... Finding invariants... 10 initial candidates Finding invariants: [0.020s CPU, 0.025s wall-clock] Checking invariant weight... [0.010s CPU, 0.004s wall-clock] Instantiating groups... [0.020s CPU, 0.026s wall-clock] Collecting mutex groups... [0.010s CPU, 0.006s wall-clock] Choosing groups... 26 uncovered facts Choosing groups: [0.020s CPU, 0.027s wall-clock] Building translation key... [0.010s CPU, 0.009s wall-clock] Computing fact groups: [0.150s CPU, 0.154s wall-clock] Building STRIPS to SAS dictionary... [0.010s CPU, 0.004s wall-clock] Building dictionary for full mutex groups... [0.000s CPU, 0.009s wall-clock] Building mutex information... Building mutex information: [0.020s CPU, 0.014s wall-clock] Translating task... Processing axioms... Simplifying axioms... [0.000s CPU, 0.000s wall-clock] Processing axioms: [0.020s CPU, 0.021s wall-clock] Translating task: [0.500s CPU, 0.496s wall-clock] 1850 effect conditions simplified 0 implied preconditions added Detecting unreachable propositions... 0 operators removed 0 axioms removed 50 propositions removed Detecting unreachable propositions: [0.300s CPU, 0.299s wall-clock] Reordering and filtering variables... 51 of 51 variables necessary. 26 of 51 mutex groups necessary. 1250 of 1250 operators necessary. 0 of 0 axiom rules necessary. Reordering and filtering variables: [0.140s CPU, 0.150s wall-clock] Translator variables: 51 Translator derived variables: 0 Translator facts: 702 Translator goal facts: 24 Translator mutex groups: 26 Translator total mutex groups size: 676 Translator operators: 1250 Translator axioms: 0 Translator task size: 10753 Translator peak memory: 42700 KB Writing output... [0.180s CPU, 0.197s wall-clock] Done! [2.030s CPU, 2.050s wall-clock] planner.py version 0.0.1 Time: 0.35s Memory: 72MB Iteration 1 Queue: [(0,0,0,True), (1,5,0,True), (2,10,0,True), (3,15,0,True), (4,20,0,True), (5,25,0,True), (6,30,0,True)] Grounded Until: 0 Solving... [start: stats after solve call] Models : 0 Calls : 1 Time : 0.404s (Solving: 0.00s 1st Model: 0.00s Unsat: 0.00s) CPU Time : 0.352s Choices : 0 Conflicts : 0 (Analyzed: 0) Restarts : 0 Problems : 1 (Average Length: 2.00 Splits: 0) Lemmas : 0 (Deleted: 0) Binary : 0 (Ratio: 0.00%) Ternary : 0 (Ratio: 0.00%) Conflict : 0 (Average Length: 0.0 Ratio: 0.00%) Loop : 0 (Average Length: 0.0 Ratio: 0.00%) Other : 0 (Average Length: 0.0 Ratio: 0.00%) Backjumps : 0 (Average: 0.00 Max: 0 Sum: 0) Executed : 0 (Average: 0.00 Max: 0 Sum: 0 Ratio: 0.00%) Bounded : 0 (Average: 0.00 Max: 0 Sum: 0 Ratio: 100.00%) Rules : 32995 Atoms : 32995 Bodies : 1 (Original: 0) Tight : Yes Variables : 0 (Eliminated: 0 Frozen: 0) Constraints : 0 (Binary: 0.0% Ternary: 0.0% Other: 0.0%) Memory Peak : 208MB Max. Length : 0 steps Models : 0 [endof: stats after solve call] Solving Time: 0.00s Memory: 144MB (+72MB) UNSAT Iteration Time: 0.00s Iteration 2 Queue: [(1,5,0,True), (2,10,0,True), (3,15,0,True), (4,20,0,True), (5,25,0,True), (6,30,0,True)] Grounded Until: 0 Expected Memory: 144MB Grounding... [('step', [1]), ('step', [2]), ('step', [3]), ('step', [4]), ('step', [5]), ('check', [5])] Grounding Time: 0.14s Memory: 147MB (+3MB) Unblocking actions... Solving... [start: stats after solve call] Models : 0 Calls : 2 Time : 0.601s (Solving: 0.00s 1st Model: 0.00s Unsat: 0.00s) CPU Time : 0.548s Choices : 0 Conflicts : 0 (Analyzed: 0) Restarts : 0 Problems : 2 (Average Length: 4.50 Splits: 0) Lemmas : 0 (Deleted: 0) Binary : 0 (Ratio: 0.00%) Ternary : 0 (Ratio: 0.00%) Conflict : 0 (Average Length: 0.0 Ratio: 0.00%) Loop : 0 (Average Length: 0.0 Ratio: 0.00%) Other : 0 (Average Length: 0.0 Ratio: 0.00%) Backjumps : 0 (Average: 0.00 Max: 0 Sum: 0) Executed : 0 (Average: 0.00 Max: 0 Sum: 0 Ratio: 0.00%) Bounded : 0 (Average: 0.00 Max: 0 Sum: 0 Ratio: 100.00%) Rules : 32995 Atoms : 32995 Bodies : 1 (Original: 0) Tight : Yes Variables : 9050 (Eliminated: 0 Frozen: 2905) Constraints : 8839 (Binary: 92.8% Ternary: 4.2% Other: 2.9%) Memory Peak : 208MB Max. Length : 0 steps Models : 0 [endof: stats after solve call] Solving Time: 0.01s Memory: 150MB (+3MB) UNSAT Iteration Time: 0.20s Iteration 3 Queue: [(2,10,0,True), (3,15,0,True), (4,20,0,True), (5,25,0,True), (6,30,0,True)] Grounded Until: 5 Expected Memory: 156.0MB Grounding... [('step', [6]), ('step', [7]), ('step', [8]), ('step', [9]), ('step', [10]), ('check', [10])] Grounding Time: 0.17s Memory: 158MB (+8MB) Unblocking actions... Solving... [start: stats after solve call] Models : 0 Calls : 3 Time : 0.837s (Solving: 0.00s 1st Model: 0.00s Unsat: 0.00s) CPU Time : 0.784s Choices : 0 Conflicts : 0 (Analyzed: 0) Restarts : 0 Problems : 3 (Average Length: 7.00 Splits: 0) Lemmas : 0 (Deleted: 0) Binary : 0 (Ratio: 0.00%) Ternary : 0 (Ratio: 0.00%) Conflict : 0 (Average Length: 0.0 Ratio: 0.00%) Loop : 0 (Average Length: 0.0 Ratio: 0.00%) Other : 0 (Average Length: 0.0 Ratio: 0.00%) Backjumps : 0 (Average: 0.00 Max: 0 Sum: 0) Executed : 0 (Average: 0.00 Max: 0 Sum: 0 Ratio: 0.00%) Bounded : 0 (Average: 0.00 Max: 0 Sum: 0 Ratio: 100.00%) Rules : 32995 Atoms : 32995 Bodies : 1 (Original: 0) Tight : Yes Variables : 18601 (Eliminated: 0 Frozen: 6075) Constraints : 45707 (Binary: 93.8% Ternary: 4.4% Other: 1.8%) Memory Peak : 208MB Max. Length : 5 steps Models : 0 [endof: stats after solve call] Solving Time: 0.01s Memory: 161MB (+3MB) UNSAT Iteration Time: 0.24s Iteration 4 Queue: [(3,15,0,True), (4,20,0,True), (5,25,0,True), (6,30,0,True)] Grounded Until: 10 Expected Memory: 172.0MB Grounding... [('step', [11]), ('step', [12]), ('step', [13]), ('step', [14]), ('step', [15]), ('check', [15])] Grounding Time: 0.16s Memory: 167MB (+6MB) Unblocking actions... Solving... [start: stats after solve call] Models : 0 Calls : 4 Time : 1.077s (Solving: 0.00s 1st Model: 0.00s Unsat: 0.00s) CPU Time : 1.024s Choices : 0 Conflicts : 0 (Analyzed: 0) Restarts : 0 Problems : 4 (Average Length: 9.50 Splits: 0) Lemmas : 0 (Deleted: 0) Binary : 0 (Ratio: 0.00%) Ternary : 0 (Ratio: 0.00%) Conflict : 0 (Average Length: 0.0 Ratio: 0.00%) Loop : 0 (Average Length: 0.0 Ratio: 0.00%) Other : 0 (Average Length: 0.0 Ratio: 0.00%) Backjumps : 0 (Average: 0.00 Max: 0 Sum: 0) Executed : 0 (Average: 0.00 Max: 0 Sum: 0 Ratio: 0.00%) Bounded : 0 (Average: 0.00 Max: 0 Sum: 0 Ratio: 100.00%) Rules : 32995 Atoms : 32995 Bodies : 1 (Original: 0) Tight : Yes Variables : 28542 (Eliminated: 0 Frozen: 9375) Constraints : 107252 (Binary: 94.2% Ternary: 4.4% Other: 1.4%) Memory Peak : 208MB Max. Length : 10 steps Models : 0 [endof: stats after solve call] Solving Time: 0.01s Memory: 171MB (+4MB) UNSAT Iteration Time: 0.24s Iteration 5 Queue: [(4,20,0,True), (5,25,0,True), (6,30,0,True)] Grounded Until: 15 Expected Memory: 182.0MB Grounding... [('step', [16]), ('step', [17]), ('step', [18]), ('step', [19]), ('step', [20]), ('check', [20])] Grounding Time: 0.20s Memory: 179MB (+8MB) Unblocking actions... Solving... [start: stats after solve call] Models : 0 Calls : 5 Time : 1.353s (Solving: 0.00s 1st Model: 0.00s Unsat: 0.00s) CPU Time : 1.300s Choices : 0 Conflicts : 1 (Analyzed: 0) Restarts : 0 Problems : 5 (Average Length: 12.00 Splits: 0) Lemmas : 0 (Deleted: 0) Binary : 0 (Ratio: 0.00%) Ternary : 0 (Ratio: 0.00%) Conflict : 0 (Average Length: 0.0 Ratio: 0.00%) Loop : 0 (Average Length: 0.0 Ratio: 0.00%) Other : 0 (Average Length: 0.0 Ratio: 0.00%) Backjumps : 0 (Average: 0.00 Max: 0 Sum: 0) Executed : 0 (Average: 0.00 Max: 0 Sum: 0 Ratio: 0.00%) Bounded : 0 (Average: 0.00 Max: 0 Sum: 0 Ratio: 100.00%) Rules : 32995 Atoms : 32995 Bodies : 1 (Original: 0) Tight : Yes Variables : 38928 (Eliminated: 0 Frozen: 12755) Constraints : 185882 (Binary: 94.4% Ternary: 4.4% Other: 1.2%) Memory Peak : 208MB Max. Length : 15 steps Models : 0 [endof: stats after solve call] Solving Time: 0.02s Memory: 185MB (+6MB) UNSAT Iteration Time: 0.28s Iteration 6 Queue: [(5,25,0,True), (6,30,0,True)] Grounded Until: 20 Expected Memory: 199.0MB Grounding... [('step', [21]), ('step', [22]), ('step', [23]), ('step', [24]), ('step', [25]), ('check', [25])] Grounding Time: 0.17s Memory: 190MB (+5MB) Unblocking actions... Solving... [start: stats after solve call] Models : 0 Calls : 6 Time : 1.606s (Solving: 0.01s 1st Model: 0.00s Unsat: 0.01s) CPU Time : 1.552s Choices : 0 Conflicts : 2 (Analyzed: 0) Restarts : 0 Problems : 6 (Average Length: 14.50 Splits: 0) Lemmas : 0 (Deleted: 0) Binary : 0 (Ratio: 0.00%) Ternary : 0 (Ratio: 0.00%) Conflict : 0 (Average Length: 0.0 Ratio: 0.00%) Loop : 0 (Average Length: 0.0 Ratio: 0.00%) Other : 0 (Average Length: 0.0 Ratio: 0.00%) Backjumps : 0 (Average: 0.00 Max: 0 Sum: 0) Executed : 0 (Average: 0.00 Max: 0 Sum: 0 Ratio: 0.00%) Bounded : 0 (Average: 0.00 Max: 0 Sum: 0 Ratio: 100.00%) Rules : 32995 Atoms : 32995 Bodies : 1 (Original: 0) Tight : Yes Variables : 49339 (Eliminated: 0 Frozen: 16135) Constraints : 264802 (Binary: 94.4% Ternary: 4.4% Other: 1.1%) Memory Peak : 208MB Max. Length : 20 steps Models : 0 [endof: stats after solve call] Solving Time: 0.02s Memory: 197MB (+7MB) UNSAT Iteration Time: 0.26s Iteration 7 Queue: [(6,30,0,True)] Grounded Until: 25 Expected Memory: 211.0MB Grounding... [('step', [26]), ('step', [27]), ('step', [28]), ('step', [29]), ('step', [30]), ('check', [30])] Grounding Time: 0.17s Memory: 202MB (+5MB) Unblocking actions... Solving... [start: stats after solve call] Models : 0 Calls : 7 Time : 1.871s (Solving: 0.01s 1st Model: 0.00s Unsat: 0.01s) CPU Time : 1.816s Choices : 0 Conflicts : 3 (Analyzed: 0) Restarts : 0 Problems : 7 (Average Length: 17.00 Splits: 0) Lemmas : 0 (Deleted: 0) Binary : 0 (Ratio: 0.00%) Ternary : 0 (Ratio: 0.00%) Conflict : 0 (Average Length: 0.0 Ratio: 0.00%) Loop : 0 (Average Length: 0.0 Ratio: 0.00%) Other : 0 (Average Length: 0.0 Ratio: 0.00%) Backjumps : 0 (Average: 0.00 Max: 0 Sum: 0) Executed : 0 (Average: 0.00 Max: 0 Sum: 0 Ratio: 0.00%) Bounded : 0 (Average: 0.00 Max: 0 Sum: 0 Ratio: 100.00%) Rules : 32995 Atoms : 32995 Bodies : 1 (Original: 0) Tight : Yes Variables : 59750 (Eliminated: 0 Frozen: 19515) Constraints : 343722 (Binary: 94.5% Ternary: 4.4% Other: 1.1%) Memory Peak : 210MB Max. Length : 25 steps Models : 0 [endof: stats after solve call] Solving Time: 0.02s Memory: 205MB (+3MB) UNSAT Iteration Time: 0.27s Iteration 8 Queue: [(7,35,0,True), (8,40,0,True), (9,45,0,True), (10,50,0,True), (11,55,0,True), (12,60,0,True), (13,65,0,True)] Grounded Until: 30 Expected Memory: 219.0MB Grounding... [('step', [31]), ('step', [32]), ('step', [33]), ('step', [34]), ('step', [35]), ('check', [35])] Grounding Time: 0.18s Memory: 211MB (+6MB) Unblocking actions... Solving... [start: stats after solve call] Models : 0 Calls : 8 Time : 2.150s (Solving: 0.02s 1st Model: 0.00s Unsat: 0.02s) CPU Time : 2.096s Choices : 0 Conflicts : 4 (Analyzed: 0) Restarts : 0 Problems : 8 (Average Length: 19.50 Splits: 0) Lemmas : 0 (Deleted: 0) Binary : 0 (Ratio: 0.00%) Ternary : 0 (Ratio: 0.00%) Conflict : 0 (Average Length: 0.0 Ratio: 0.00%) Loop : 0 (Average Length: 0.0 Ratio: 0.00%) Other : 0 (Average Length: 0.0 Ratio: 0.00%) Backjumps : 0 (Average: 0.00 Max: 0 Sum: 0) Executed : 0 (Average: 0.00 Max: 0 Sum: 0 Ratio: 0.00%) Bounded : 0 (Average: 0.00 Max: 0 Sum: 0 Ratio: 100.00%) Rules : 32995 Atoms : 32995 Bodies : 1 (Original: 0) Tight : Yes Variables : 70161 (Eliminated: 0 Frozen: 22895) Constraints : 422642 (Binary: 94.5% Ternary: 4.4% Other: 1.1%) Memory Peak : 222MB Max. Length : 30 steps Models : 0 [endof: stats after solve call] Solving Time: 0.03s Memory: 222MB (+11MB) UNSAT Iteration Time: 0.28s Iteration 9 Queue: [(8,40,0,True), (9,45,0,True), (10,50,0,True), (11,55,0,True), (12,60,0,True), (13,65,0,True)] Grounded Until: 35 Expected Memory: 239.0MB Grounding... [('step', [36]), ('step', [37]), ('step', [38]), ('step', [39]), ('step', [40]), ('check', [40])] Grounding Time: 0.25s Memory: 228MB (+6MB) Unblocking actions... Solving... [start: stats after solve call] Models : 0 Calls : 9 Time : 2.525s (Solving: 0.03s 1st Model: 0.00s Unsat: 0.03s) CPU Time : 2.472s Choices : 70 (Domain: 70) Conflicts : 22 (Analyzed: 17) Restarts : 0 Problems : 9 (Average Length: 22.00 Splits: 0) Lemmas : 17 (Deleted: 0) Binary : 3 (Ratio: 17.65%) Ternary : 0 (Ratio: 0.00%) Conflict : 17 (Average Length: 18.2 Ratio: 100.00%) Loop : 0 (Average Length: 0.0 Ratio: 0.00%) Other : 0 (Average Length: 0.0 Ratio: 0.00%) Backjumps : 17 (Average: 6.59 Max: 54 Sum: 112) Executed : 15 (Average: 4.12 Max: 54 Sum: 70 Ratio: 62.50%) Bounded : 2 (Average: 21.00 Max: 41 Sum: 42 Ratio: 37.50%) Rules : 32995 Atoms : 32995 Bodies : 1 (Original: 0) Tight : Yes Variables : 80572 (Eliminated: 0 Frozen: 26275) Constraints : 501562 (Binary: 94.5% Ternary: 4.4% Other: 1.1%) Memory Peak : 240MB Max. Length : 35 steps Models : 0 [endof: stats after solve call] Solving Time: 0.04s Memory: 233MB (+5MB) UNSAT Iteration Time: 0.38s Iteration 10 Queue: [(9,45,0,True), (10,50,0,True), (11,55,0,True), (12,60,0,True), (13,65,0,True)] Grounded Until: 40 Expected Memory: 250.0MB Grounding... [('step', [41]), ('step', [42]), ('step', [43]), ('step', [44]), ('step', [45]), ('check', [45])] Grounding Time: 0.17s Memory: 238MB (+5MB) Unblocking actions... Solving... [start: stats after solve call] Models : 0 Calls : 10 Time : 2.869s (Solving: 0.10s 1st Model: 0.00s Unsat: 0.10s) CPU Time : 2.824s Choices : 383 (Domain: 383) Conflicts : 85 (Analyzed: 79) Restarts : 0 Problems : 10 (Average Length: 24.50 Splits: 0) Lemmas : 79 (Deleted: 0) Binary : 5 (Ratio: 6.33%) Ternary : 0 (Ratio: 0.00%) Conflict : 79 (Average Length: 91.3 Ratio: 100.00%) Loop : 0 (Average Length: 0.0 Ratio: 0.00%) Other : 0 (Average Length: 0.0 Ratio: 0.00%) Backjumps : 79 (Average: 7.77 Max: 63 Sum: 614) Executed : 72 (Average: 4.85 Max: 63 Sum: 383 Ratio: 62.38%) Bounded : 7 (Average: 33.00 Max: 47 Sum: 231 Ratio: 37.62%) Rules : 32995 Atoms : 32995 Bodies : 1 (Original: 0) Tight : Yes Variables : 90983 (Eliminated: 0 Frozen: 29655) Constraints : 580482 (Binary: 94.5% Ternary: 4.4% Other: 1.1%) Memory Peak : 251MB Max. Length : 40 steps Models : 0 [endof: stats after solve call] Solving Time: 0.09s Memory: 241MB (+3MB) UNSAT Iteration Time: 0.35s Iteration 11 Queue: [(10,50,0,True), (11,55,0,True), (12,60,0,True), (13,65,0,True)] Grounded Until: 45 Expected Memory: 258.0MB Grounding... [('step', [46]), ('step', [47]), ('step', [48]), ('step', [49]), ('step', [50]), ('check', [50])] Grounding Time: 0.18s Memory: 247MB (+6MB) Unblocking actions... Solving... [start: stats after solve call] Models : 0 Calls : 11 Time : 3.222s (Solving: 0.14s 1st Model: 0.00s Unsat: 0.14s) CPU Time : 3.176s Choices : 998 (Domain: 998) Conflicts : 140 (Analyzed: 133) Restarts : 0 Problems : 11 (Average Length: 27.00 Splits: 0) Lemmas : 133 (Deleted: 0) Binary : 20 (Ratio: 15.04%) Ternary : 0 (Ratio: 0.00%) Conflict : 133 (Average Length: 102.8 Ratio: 100.00%) Loop : 0 (Average Length: 0.0 Ratio: 0.00%) Other : 0 (Average Length: 0.0 Ratio: 0.00%) Backjumps : 133 (Average: 9.27 Max: 63 Sum: 1233) Executed : 122 (Average: 7.50 Max: 63 Sum: 998 Ratio: 80.94%) Bounded : 11 (Average: 21.36 Max: 47 Sum: 235 Ratio: 19.06%) Rules : 32995 Atoms : 32995 Bodies : 1 (Original: 0) Tight : Yes Variables : 101394 (Eliminated: 0 Frozen: 33035) Constraints : 613973 (Binary: 94.5% Ternary: 4.4% Other: 1.1%) Memory Peak : 262MB Max. Length : 45 steps Models : 0 [endof: stats after solve call] Solving Time: 0.07s Memory: 252MB (+5MB) UNSAT Iteration Time: 0.36s Iteration 12 Queue: [(11,55,0,True), (12,60,0,True), (13,65,0,True)] Grounded Until: 50 Expected Memory: 269.0MB Grounding... [('step', [51]), ('step', [52]), ('step', [53]), ('step', [54]), ('step', [55]), ('check', [55])] Grounding Time: 0.17s Memory: 257MB (+5MB) Unblocking actions... Solving... [start: stats after solve call] Models : 0 Calls : 12 Time : 3.682s (Solving: 0.30s 1st Model: 0.00s Unsat: 0.30s) CPU Time : 3.636s Choices : 4898 (Domain: 4898) Conflicts : 218 (Analyzed: 210) Restarts : 1 (Average: 210.00 Last: 62) Problems : 12 (Average Length: 29.50 Splits: 0) Lemmas : 210 (Deleted: 0) Binary : 58 (Ratio: 27.62%) Ternary : 0 (Ratio: 0.00%) Conflict : 210 (Average Length: 260.8 Ratio: 100.00%) Loop : 0 (Average Length: 0.0 Ratio: 0.00%) Other : 0 (Average Length: 0.0 Ratio: 0.00%) Backjumps : 210 (Average: 24.48 Max: 179 Sum: 5141) Executed : 191 (Average: 23.32 Max: 179 Sum: 4898 Ratio: 95.27%) Bounded : 19 (Average: 12.79 Max: 47 Sum: 243 Ratio: 4.73%) Rules : 32995 Atoms : 32995 Bodies : 1 (Original: 0) Tight : Yes Variables : 111805 (Eliminated: 0 Frozen: 36415) Constraints : 692893 (Binary: 94.5% Ternary: 4.4% Other: 1.1%) Memory Peak : 274MB Max. Length : 50 steps Models : 0 [endof: stats after solve call] Solving Time: 0.19s Memory: 271MB (+14MB) UNSAT Iteration Time: 0.47s Iteration 13 Queue: [(12,60,0,True), (13,65,0,True)] Grounded Until: 55 Expected Memory: 290.0MB Grounding... [('step', [56]), ('step', [57]), ('step', [58]), ('step', [59]), ('step', [60]), ('check', [60])] Grounding Time: 0.20s Memory: 271MB (+0MB) Unblocking actions... Solving... [start: stats after solve call] Models : 0 Calls : 13 Time : 4.348s (Solving: 0.63s 1st Model: 0.00s Unsat: 0.63s) CPU Time : 4.304s Choices : 15512 (Domain: 15512) Conflicts : 329 (Analyzed: 320) Restarts : 2 (Average: 160.00 Last: 62) Problems : 13 (Average Length: 32.00 Splits: 0) Lemmas : 320 (Deleted: 0) Binary : 112 (Ratio: 35.00%) Ternary : 2 (Ratio: 0.62%) Conflict : 320 (Average Length: 575.6 Ratio: 100.00%) Loop : 0 (Average Length: 0.0 Ratio: 0.00%) Other : 0 (Average Length: 0.0 Ratio: 0.00%) Backjumps : 320 (Average: 49.27 Max: 346 Sum: 15766) Executed : 290 (Average: 48.48 Max: 346 Sum: 15512 Ratio: 98.39%) Bounded : 30 (Average: 8.47 Max: 47 Sum: 254 Ratio: 1.61%) Rules : 32995 Atoms : 32995 Bodies : 1 (Original: 0) Tight : Yes Variables : 122216 (Eliminated: 0 Frozen: 39795) Constraints : 771813 (Binary: 94.5% Ternary: 4.4% Other: 1.1%) Memory Peak : 289MB Max. Length : 55 steps Models : 0 [endof: stats after solve call] Solving Time: 0.37s Memory: 275MB (+4MB) UNSAT Iteration Time: 0.67s Iteration 14 Queue: [(13,65,0,True)] Grounded Until: 60 Expected Memory: 294.0MB Grounding... [('step', [61]), ('step', [62]), ('step', [63]), ('step', [64]), ('step', [65]), ('check', [65])] Grounding Time: 0.22s Memory: 280MB (+5MB) Unblocking actions... Solving... [start: stats after solve call] Models : 0 Calls : 14 Time : 5.228s (Solving: 1.14s 1st Model: 0.00s Unsat: 1.14s) CPU Time : 5.184s Choices : 36277 (Domain: 36277) Conflicts : 459 (Analyzed: 449) Restarts : 3 (Average: 149.67 Last: 62) Problems : 14 (Average Length: 34.50 Splits: 0) Lemmas : 449 (Deleted: 0) Binary : 188 (Ratio: 41.87%) Ternary : 2 (Ratio: 0.45%) Conflict : 449 (Average Length: 555.6 Ratio: 100.00%) Loop : 0 (Average Length: 0.0 Ratio: 0.00%) Other : 0 (Average Length: 0.0 Ratio: 0.00%) Backjumps : 449 (Average: 81.39 Max: 503 Sum: 36546) Executed : 404 (Average: 80.80 Max: 503 Sum: 36277 Ratio: 99.26%) Bounded : 45 (Average: 5.98 Max: 47 Sum: 269 Ratio: 0.74%) Rules : 32995 Atoms : 32995 Bodies : 1 (Original: 0) Tight : Yes Variables : 132627 (Eliminated: 0 Frozen: 43175) Constraints : 850733 (Binary: 94.5% Ternary: 4.4% Other: 1.0%) Memory Peak : 299MB Max. Length : 60 steps Models : 0 [endof: stats after solve call] Solving Time: 0.55s Memory: 285MB (+5MB) UNSAT Iteration Time: 0.89s Iteration 15 Queue: [(14,70,0,True), (15,75,0,True), (16,80,0,True), (17,85,0,True), (18,90,0,True), (19,95,0,True), (20,100,0,True)] Grounded Until: 65 Expected Memory: 304.0MB Grounding... [('step', [66]), ('step', [67]), ('step', [68]), ('step', [69]), ('step', [70]), ('check', [70])] Grounding Time: 0.20s Memory: 288MB (+3MB) Unblocking actions... Solving... [start: stats after solve call] Models : 0 Calls : 15 Time : 6.241s (Solving: 1.80s 1st Model: 0.00s Unsat: 1.80s) CPU Time : 6.196s Choices : 60489 (Domain: 60489) Conflicts : 668 (Analyzed: 657) Restarts : 5 (Average: 131.40 Last: 62) Problems : 15 (Average Length: 37.00 Splits: 0) Lemmas : 657 (Deleted: 0) Binary : 252 (Ratio: 38.36%) Ternary : 2 (Ratio: 0.30%) Conflict : 657 (Average Length: 633.8 Ratio: 100.00%) Loop : 0 (Average Length: 0.0 Ratio: 0.00%) Other : 0 (Average Length: 0.0 Ratio: 0.00%) Backjumps : 657 (Average: 92.93 Max: 744 Sum: 61058) Executed : 596 (Average: 92.07 Max: 744 Sum: 60489 Ratio: 99.07%) Bounded : 61 (Average: 9.33 Max: 72 Sum: 569 Ratio: 0.93%) Rules : 32995 Atoms : 32995 Bodies : 1 (Original: 0) Tight : Yes Variables : 143038 (Eliminated: 0 Frozen: 46555) Constraints : 929653 (Binary: 94.5% Ternary: 4.4% Other: 1.0%) Memory Peak : 309MB Max. Length : 65 steps Models : 0 [endof: stats after solve call] Solving Time: 0.70s Memory: 294MB (+6MB) UNSAT Iteration Time: 1.02s Iteration 16 Queue: [(15,75,0,True), (16,80,0,True), (17,85,0,True), (18,90,0,True), (19,95,0,True), (20,100,0,True)] Grounded Until: 70 Expected Memory: 313.0MB Grounding... [('step', [71]), ('step', [72]), ('step', [73]), ('step', [74]), ('step', [75]), ('check', [75])] Grounding Time: 0.19s Memory: 297MB (+3MB) Unblocking actions... Solving... [start: stats after solve call] Models : 0 Calls : 16 Time : 10.528s (Solving: 5.73s 1st Model: 0.00s Unsat: 5.73s) CPU Time : 10.488s Choices : 102898 (Domain: 102898) Conflicts : 4367 (Analyzed: 4355) Restarts : 47 (Average: 92.66 Last: 67) Problems : 16 (Average Length: 39.50 Splits: 0) Lemmas : 4355 (Deleted: 1111) Binary : 349 (Ratio: 8.01%) Ternary : 5 (Ratio: 0.11%) Conflict : 4355 (Average Length: 1480.9 Ratio: 100.00%) Loop : 0 (Average Length: 0.0 Ratio: 0.00%) Other : 0 (Average Length: 0.0 Ratio: 0.00%) Backjumps : 4355 (Average: 22.88 Max: 1526 Sum: 99637) Executed : 4282 (Average: 22.66 Max: 1526 Sum: 98678 Ratio: 99.04%) Bounded : 73 (Average: 13.14 Max: 77 Sum: 959 Ratio: 0.96%) Rules : 32995 Atoms : 32995 Bodies : 1 (Original: 0) Tight : Yes Variables : 153449 (Eliminated: 0 Frozen: 49935) Constraints : 976291 (Binary: 94.5% Ternary: 4.5% Other: 1.1%) Memory Peak : 318MB Max. Length : 70 steps Models : 0 [endof: stats after solve call] Solving Time: 3.97s Memory: 303MB (+6MB) UNSAT Iteration Time: 4.30s Iteration 17 Queue: [(16,80,0,True), (17,85,0,True), (18,90,0,True), (19,95,0,True), (20,100,0,True)] Grounded Until: 75 Expected Memory: 322.0MB Grounding... [('step', [76]), ('step', [77]), ('step', [78]), ('step', [79]), ('step', [80]), ('check', [80])] Grounding Time: 0.23s Memory: 306MB (+3MB) Unblocking actions... Solving... [start: stats after solve call] Models : 0+ Calls : 17 Time : 21.989s (Solving: 16.76s 1st Model: 0.00s Unsat: 5.73s) CPU Time : 21.952s Choices : 226774 (Domain: 226774) Conflicts : 13416 (Analyzed: 13404) Restarts : 147 (Average: 91.18 Last: 67) Problems : 17 (Average Length: 42.00 Splits: 0) Lemmas : 13404 (Deleted: 10025) Binary : 475 (Ratio: 3.54%) Ternary : 17 (Ratio: 0.13%) Conflict : 13404 (Average Length: 2125.0 Ratio: 100.00%) Loop : 0 (Average Length: 0.0 Ratio: 0.00%) Other : 0 (Average Length: 0.0 Ratio: 0.00%) Backjumps : 13404 (Average: 15.07 Max: 1707 Sum: 201939) Executed : 13327 (Average: 14.99 Max: 1707 Sum: 200976 Ratio: 99.52%) Bounded : 77 (Average: 12.51 Max: 77 Sum: 963 Ratio: 0.48%) Rules : 32995 Atoms : 32995 Bodies : 1 (Original: 0) Tight : Yes Variables : 163860 (Eliminated: 0 Frozen: 53315) Constraints : 1055111 (Binary: 94.5% Ternary: 4.5% Other: 1.0%) Memory Peak : 330MB Max. Length : 75 steps Models : 0 [endof: stats after solve call] Solving Time: 11.09s Memory: 327MB (+21MB) UNKNOWN Iteration Time: 11.48s Iteration 18 Queue: [(17,85,0,True), (18,90,0,True), (19,95,0,True), (20,100,0,True)] Grounded Until: 80 Expected Memory: 351.0MB Grounding... [('step', [81]), ('step', [82]), ('step', [83]), ('step', [84]), ('step', [85]), ('check', [85])] Grounding Time: 0.37s Memory: 340MB (+13MB) Unblocking actions... Solving... [start: stats after solve call] Models : 0+ Calls : 18 Time : 49.053s (Solving: 43.27s 1st Model: 0.00s Unsat: 5.73s) CPU Time : 49.028s Choices : 704409 (Domain: 704409) Conflicts : 22749 (Analyzed: 22737) Restarts : 247 (Average: 92.05 Last: 67) Problems : 18 (Average Length: 44.50 Splits: 0) Lemmas : 22737 (Deleted: 18872) Binary : 555 (Ratio: 2.44%) Ternary : 22 (Ratio: 0.10%) Conflict : 22737 (Average Length: 8972.2 Ratio: 100.00%) Loop : 0 (Average Length: 0.0 Ratio: 0.00%) Other : 0 (Average Length: 0.0 Ratio: 0.00%) Backjumps : 22737 (Average: 25.50 Max: 3291 Sum: 579891) Executed : 22658 (Average: 25.46 Max: 3291 Sum: 578926 Ratio: 99.83%) Bounded : 79 (Average: 12.22 Max: 77 Sum: 965 Ratio: 0.17%) Rules : 32995 Atoms : 32995 Bodies : 1 (Original: 0) Tight : Yes Variables : 174271 (Eliminated: 0 Frozen: 56695) Constraints : 1134031 (Binary: 94.5% Ternary: 4.5% Other: 1.0%) Memory Peak : 661MB Max. Length : 80 steps Models : 0 [endof: stats after solve call] Solving Time: 26.57s Memory: 661MB (+321MB) UNKNOWN Iteration Time: 27.08s Iteration 19 Queue: [(18,90,0,True), (19,95,0,True), (20,100,0,True)] Grounded Until: 85 Expected Memory: 995.0MB Grounding... [('step', [86]), ('step', [87]), ('step', [88]), ('step', [89]), ('step', [90]), ('check', [90])] Grounding Time: 0.17s Memory: 662MB (+1MB) Unblocking actions... Solving... [start: stats after solve call] Models : 1+ Calls : 19 Time : 49.911s (Solving: 43.70s 1st Model: 0.41s Unsat: 5.73s) CPU Time : 49.888s Choices : 785188 (Domain: 785188) Conflicts : 22946 (Analyzed: 22934) Restarts : 249 (Average: 92.10 Last: 67) Model-Level : 6687.0 Problems : 19 (Average Length: 47.00 Splits: 0) Lemmas : 22934 (Deleted: 18872) Binary : 567 (Ratio: 2.47%) Ternary : 22 (Ratio: 0.10%) Conflict : 22934 (Average Length: 8900.5 Ratio: 100.00%) Loop : 0 (Average Length: 0.0 Ratio: 0.00%) Other : 0 (Average Length: 0.0 Ratio: 0.00%) Backjumps : 22934 (Average: 28.52 Max: 6474 Sum: 654077) Executed : 22853 (Average: 28.48 Max: 6474 Sum: 653110 Ratio: 99.85%) Bounded : 81 (Average: 11.94 Max: 77 Sum: 967 Ratio: 0.15%) Rules : 32995 Atoms : 32995 Bodies : 1 (Original: 0) Tight : Yes Variables : 184682 (Eliminated: 0 Frozen: 60075) Constraints : 1212951 (Binary: 94.5% Ternary: 4.5% Other: 1.0%) Memory Peak : 688MB Max. Length : 85 steps Models : 1 [endof: stats after solve call] Solving Time: 0.51s Memory: 669MB (+7MB) SAT Testing... SERIALIZABLE Testing Time: 0.33s Memory: 677MB (+8MB) Answer: 1 occurs(action(("unstack","x","n")),1) occurs(action(("put-down","x")),2) occurs(action(("unstack","n","l")),3) occurs(action(("put-down","n")),4) occurs(action(("unstack","u","i")),5) occurs(action(("put-down","u")),6) occurs(action(("unstack","a","v")),7) occurs(action(("put-down","a")),8) occurs(action(("unstack","v","c")),9) occurs(action(("stack","v","a")),10) occurs(action(("unstack","c","r")),11) occurs(action(("put-down","c")),12) occurs(action(("unstack","r","s")),13) occurs(action(("put-down","r")),14) occurs(action(("unstack","s","h")),15) occurs(action(("put-down","s")),16) occurs(action(("unstack","h","o")),17) occurs(action(("stack","h","u")),18) occurs(action(("unstack","l","e")),19) occurs(action(("put-down","l")),20) occurs(action(("pick-up","p")),21) occurs(action(("stack","p","c")),22) occurs(action(("unstack","o","d")),23) occurs(action(("put-down","o")),24) occurs(action(("pick-up","x")),25) occurs(action(("stack","x","p")),26) occurs(action(("pick-up","e")),27) occurs(action(("stack","e","s")),28) occurs(action(("unstack","i","k")),29) occurs(action(("stack","i","n")),30) occurs(action(("unstack","d","w")),31) occurs(action(("stack","d","r")),32) occurs(action(("unstack","w","y")),33) occurs(action(("put-down","w")),34) occurs(action(("unstack","y","g")),35) occurs(action(("stack","y","l")),36) occurs(action(("unstack","g","j")),37) occurs(action(("stack","g","w")),38) occurs(action(("unstack","j","q")),39) occurs(action(("stack","j","g")),40) occurs(action(("unstack","q","m")),41) occurs(action(("stack","q","h")),42) occurs(action(("unstack","i","n")),43) occurs(action(("stack","i","q")),44) occurs(action(("unstack","k","t")),45) occurs(action(("stack","k","o")),46) occurs(action(("unstack","t","f")),47) occurs(action(("put-down","t")),48) occurs(action(("pick-up","f")),49) occurs(action(("stack","f","i")),50) occurs(action(("unstack","v","a")),51) occurs(action(("stack","v","f")),52) occurs(action(("unstack","e","s")),53) occurs(action(("stack","e","v")),54) occurs(action(("unstack","x","p")),55) occurs(action(("stack","x","e")),56) occurs(action(("unstack","m","b")),57) occurs(action(("stack","m","x")),58) occurs(action(("unstack","p","c")),59) occurs(action(("stack","p","m")),60) occurs(action(("unstack","k","o")),61) occurs(action(("stack","k","p")),62) occurs(action(("pick-up","b")),63) occurs(action(("stack","b","k")),64) occurs(action(("unstack","d","r")),65) occurs(action(("stack","d","b")),66) occurs(action(("unstack","j","g")),67) occurs(action(("stack","j","d")),68) occurs(action(("unstack","g","w")),69) occurs(action(("stack","g","j")),70) occurs(action(("pick-up","c")),71) occurs(action(("stack","c","g")),72) occurs(action(("pick-up","r")),73) occurs(action(("stack","r","c")),74) occurs(action(("pick-up","a")),75) occurs(action(("stack","a","r")),76) occurs(action(("unstack","y","l")),77) occurs(action(("stack","y","a")),78) occurs(action(("pick-up","s")),79) occurs(action(("stack","s","y")),80) occurs(action(("pick-up","o")),81) occurs(action(("stack","o","s")),82) occurs(action(("pick-up","n")),83) occurs(action(("stack","n","o")),84) occurs(action(("pick-up","w")),85) occurs(action(("stack","w","n")),86) occurs(action(("pick-up","t")),87) occurs(action(("stack","t","w")),88) occurs(action(("pick-up","l")),89) occurs(action(("stack","l","t")),90) SATISFIABLE Models : 1+ Calls : 19 Time : 49.911s (Solving: 43.70s 1st Model: 0.41s Unsat: 5.73s) CPU Time : 49.888s Choices : 785188 (Domain: 785188) Conflicts : 22946 (Analyzed: 22934) Restarts : 249 (Average: 92.10 Last: 67) Model-Level : 6687.0 Problems : 19 (Average Length: 47.00 Splits: 0) Lemmas : 22934 (Deleted: 18872) Binary : 567 (Ratio: 2.47%) Ternary : 22 (Ratio: 0.10%) Conflict : 22934 (Average Length: 8900.5 Ratio: 100.00%) Loop : 0 (Average Length: 0.0 Ratio: 0.00%) Other : 0 (Average Length: 0.0 Ratio: 0.00%) Backjumps : 22934 (Average: 28.52 Max: 6474 Sum: 654077) Executed : 22853 (Average: 28.48 Max: 6474 Sum: 653110 Ratio: 99.85%) Bounded : 81 (Average: 11.94 Max: 77 Sum: 967 Ratio: 0.15%) Rules : 32995 Atoms : 32995 Bodies : 1 (Original: 0) Tight : Yes Variables : 184682 (Eliminated: 0 Frozen: 60075) Constraints : 1212951 (Binary: 94.5% Ternary: 4.5% Other: 1.0%) Memory Peak : 688MB Max. Length : 90 steps Sol. Length : 90 steps Models : 1