runsolver Copyright (C) 2010 Olivier ROUSSEL

This is runsolver version 3.2.9a (svn: 651)

This program is distributed in the hope that it will be useful,
but WITHOUT ANY WARRANTY; without even the implied warranty of
MERCHANTABILITY or FITNESS FOR A PARTICULAR PURPOSE.  See the
GNU General Public License for more details.

command line: runsolver -s SIGUSR1 -M 1124 -C 300 -d 10 -w /tmp/misc2012/2012-09-02-22:42/full/p2cudf-full-1.15/upgrade/real/f4ebf9e0-360e-11e0-9e6c-00163e3d3b7c.cudf.log.runsolver /home/competition/p2cudf-full-1.15/p2cudf-full-1.15 /home/competition/data/real/f4ebf9e0-360e-11e0-9e6c-00163e3d3b7c.cudf /tmp/misc2012/2012-09-02-22:42/full/p2cudf-full-1.15/upgrade/real/f4ebf9e0-360e-11e0-9e6c-00163e3d3b7c.cudf.result -count(down),-notuptodate(solution),-aligned(solution,source,sourceversion),-unsat_recommends(solution),-count(new) 

Enforcing CPUTime limit (soft limit, will send signal-name then SIGKILL): 300 seconds
Enforcing CPUTime limit (hard limit, will send SIGXCPU): 330 seconds
Enforcing VSIZE limit (soft limit, will send signal-name then SIGKILL): 1150976 KiB
Enforcing VSIZE limit (hard limit, stack expansion will fail with SIGSEGV, brk() and mmap() will return ENOMEM): 1202176 KiB

[startup+0 s]
/proc/loadavg: 1.17 1.08 1.02 2/59 11140
/proc/meminfo: memFree=604712/1022884 swapFree=0/0
[pid=11140] ppid=11139 vsize=3152 CPUtime=0
/proc/11140/stat : 11140 (runsolver) R 11139 1750 1750 0 -1 4202560 0 0 0 0 0 0 0 0 20 0 1 0 117457224 3227648 32 18446744073709551615 134512640 134586868 4292105696 4292103744 4151616560 0 0 16781316 24578 0 0 0 17 0 0 0 0 0 0
/proc/11140/statm: 788 32 0 19 0 73 0
Current StackSize limit: 8192 KiB


[startup+0.162727 s]
/proc/loadavg: 1.17 1.08 1.02 2/59 11140
/proc/meminfo: memFree=604712/1022884 swapFree=0/0
[pid=11140] ppid=11139 vsize=9172 CPUtime=0
/proc/11140/stat : 11140 (p2cudf-full-1.1) S 11139 11140 1750 0 -1 4202496 461 292 0 0 0 0 0 0 20 0 1 0 117457224 9392128 332 18446744073709551615 4194304 5129932 140736239593776 140736239591920 140438281552990 0 65536 16781316 65538 0 0 0 17 0 0 0 0 0 0
/proc/11140/statm: 2293 332 280 229 0 53 0
Current children cumulated CPU time (s) 0
Current children cumulated vsize (KiB) 9172

[startup+0.200307 s]
/proc/loadavg: 1.17 1.08 1.02 2/59 11140
/proc/meminfo: memFree=604712/1022884 swapFree=0/0
[pid=11140] ppid=11139 vsize=9172 CPUtime=0
/proc/11140/stat : 11140 (p2cudf-full-1.1) S 11139 11140 1750 0 -1 4202496 461 292 0 0 0 0 0 0 20 0 1 0 117457224 9392128 332 18446744073709551615 4194304 5129932 140736239593776 140736239591920 140438281552990 0 65536 16781316 65538 0 0 0 17 0 0 0 0 0 0
/proc/11140/statm: 2293 332 280 229 0 53 0
Current children cumulated CPU time (s) 0
Current children cumulated vsize (KiB) 9172

[startup+0.300314 s]
/proc/loadavg: 1.17 1.08 1.02 2/59 11140
/proc/meminfo: memFree=604712/1022884 swapFree=0/0
[pid=11140] ppid=11139 vsize=9172 CPUtime=0
/proc/11140/stat : 11140 (p2cudf-full-1.1) S 11139 11140 1750 0 -1 4202496 461 292 0 0 0 0 0 0 20 0 1 0 117457224 9392128 332 18446744073709551615 4194304 5129932 140736239593776 140736239591920 140438281552990 0 65536 16781316 65538 0 0 0 17 0 0 0 0 0 0
/proc/11140/statm: 2293 332 280 229 0 53 0
Current children cumulated CPU time (s) 0
Current children cumulated vsize (KiB) 9172

[startup+0.700227 s]
/proc/loadavg: 1.17 1.08 1.02 2/59 11140
/proc/meminfo: memFree=604712/1022884 swapFree=0/0
[pid=11140] ppid=11139 vsize=9172 CPUtime=0
/proc/11140/stat : 11140 (p2cudf-full-1.1) S 11139 11140 1750 0 -1 4202496 461 292 0 0 0 0 0 0 20 0 1 0 117457224 9392128 332 18446744073709551615 4194304 5129932 140736239593776 140736239591920 140438281552990 0 65536 16781316 65538 0 0 0 17 0 0 0 0 0 0
/proc/11140/statm: 2293 332 280 229 0 53 0
Current children cumulated CPU time (s) 0
Current children cumulated vsize (KiB) 9172

[startup+1.50082 s]
/proc/loadavg: 1.17 1.08 1.02 3/70 11152
/proc/meminfo: memFree=566424/1022884 swapFree=0/0
[pid=11140] ppid=11139 vsize=9172 CPUtime=0
/proc/11140/stat : 11140 (p2cudf-full-1.1) S 11139 11140 1750 0 -1 4202496 461 292 0 0 0 0 0 0 20 0 1 0 117457224 9392128 332 18446744073709551615 4194304 5129932 140736239593776 140736239591920 140438281552990 0 65536 16781316 65538 0 0 0 17 0 0 0 0 0 0
/proc/11140/statm: 2293 332 280 229 0 53 0
[pid=11143] ppid=11140 vsize=1048756 CPUtime=1.38
/proc/11143/stat : 11143 (java) S 11140 11140 1750 0 -1 4202496 27852 0 15 0 127 11 0 0 20 0 10 0 117457225 1073926144 24936 18446744073709551615 4194304 4228012 140734153947616 140734153938640 140703284244085 0 0 0 16800975 18446744073709551615 0 0 17 0 0 0 6 0 0
/proc/11143/statm: 262189 24936 2343 9 0 249539 0
[pid=11143/tid=11144] ppid=11140 vsize=1048756 CPUtime=0.64
/proc/11143/task/11144/stat : 11144 (java) R 11140 11140 1750 0 -1 4202560 11786 0 3 0 59 5 0 0 20 0 10 0 117457232 1073926144 24936 18446744073709551615 4194304 4228012 140734153947616 140703290770080 140703188598543 0 4 0 16800975 0 0 0 -1 0 0 0 1 0 0
[pid=11143/tid=11145] ppid=11140 vsize=1048756 CPUtime=0
/proc/11143/task/11145/stat : 11145 (java) S 11140 11140 1750 0 -1 4202560 4 0 0 0 0 0 0 0 20 0 10 0 117457236 1073926144 24936 18446744073709551615 4194304 4228012 140734153947616 140703183416448 140703284258379 0 0 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11146] ppid=11140 vsize=1048756 CPUtime=0
/proc/11143/task/11146/stat : 11146 (java) S 11140 11140 1750 0 -1 4202560 15 0 0 0 0 0 0 0 20 0 10 0 117457237 1073926144 24936 18446744073709551615 4194304 4228012 140734153947616 140703182362640 140703284257492 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11147] ppid=11140 vsize=1048756 CPUtime=0
/proc/11143/task/11147/stat : 11147 (java) S 11140 11140 1750 0 -1 4202560 6 0 0 0 0 0 0 0 20 0 10 0 117457237 1073926144 24936 18446744073709551615 4194304 4228012 140734153947616 140703181309856 140703284257492 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11148] ppid=11140 vsize=1048756 CPUtime=0
/proc/11143/task/11148/stat : 11148 (java) S 11140 11140 1750 0 -1 4202560 0 0 0 0 0 0 0 0 20 0 10 0 117457240 1073926144 24936 18446744073709551615 4194304 4228012 140734153947616 140703180258288 140703284266016 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11149] ppid=11140 vsize=1048756 CPUtime=0.37
/proc/11143/task/11149/stat : 11149 (java) R 11140 11140 1750 0 -1 4202560 8932 0 0 0 35 2 0 0 20 0 10 0 117457240 1073926144 24936 18446744073709551615 4194304 4228012 140734153947616 140703179190680 140703269932982 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11150] ppid=11140 vsize=1048756 CPUtime=0.33
/proc/11143/task/11150/stat : 11150 (java) R 11140 11140 1750 0 -1 4202560 5855 0 0 0 31 2 0 0 20 0 10 0 117457240 1073926144 24936 18446744073709551615 4194304 4228012 140734153947616 140703178138184 140703276779455 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11151] ppid=11140 vsize=1048756 CPUtime=0
/proc/11143/task/11151/stat : 11151 (java) S 11140 11140 1750 0 -1 4202560 0 0 0 0 0 0 0 0 20 0 10 0 117457241 1073926144 24936 18446744073709551615 4194304 4228012 140734153947616 140703177100496 140703284257492 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11152] ppid=11140 vsize=1048756 CPUtime=0
/proc/11143/task/11152/stat : 11152 (java) S 11140 11140 1750 0 -1 4202560 0 0 0 0 0 0 0 0 20 0 10 0 117457241 1073926144 24936 18446744073709551615 4194304 4228012 140734153947616 140703176048000 140703284258379 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
Current children cumulated CPU time (s) 1.38
Current children cumulated vsize (KiB) 1057928

[startup+3.10079 s]
/proc/loadavg: 1.32 1.12 1.03 4/70 11152
/proc/meminfo: memFree=472184/1022884 swapFree=0/0
[pid=11140] ppid=11139 vsize=9172 CPUtime=0
/proc/11140/stat : 11140 (p2cudf-full-1.1) S 11139 11140 1750 0 -1 4202496 461 292 0 0 0 0 0 0 20 0 1 0 117457224 9392128 332 18446744073709551615 4194304 5129932 140736239593776 140736239591920 140438281552990 0 65536 16781316 65538 0 0 0 17 0 0 0 0 0 0
/proc/11140/statm: 2293 332 280 229 0 53 0
[pid=11143] ppid=11140 vsize=1051956 CPUtime=2.96
/proc/11143/stat : 11143 (java) S 11140 11140 1750 0 -1 4202496 75932 0 15 0 269 27 0 0 20 0 10 0 117457225 1077202944 71446 18446744073709551615 4194304 4228012 140734153947616 140734153938640 140703284244085 0 0 0 16800975 18446744073709551615 0 0 17 0 0 0 6 0 0
/proc/11143/statm: 262989 71446 2363 9 0 250339 0
[pid=11143/tid=11144] ppid=11140 vsize=1051956 CPUtime=1.43
/proc/11143/task/11144/stat : 11144 (java) R 11140 11140 1750 0 -1 4202560 47427 0 3 0 127 16 0 0 20 0 10 0 117457232 1077202944 71446 18446744073709551615 4194304 4228012 140734153947616 140703290770112 140703188436152 0 4 0 16800975 0 0 0 -1 0 0 0 2 0 0
[pid=11143/tid=11145] ppid=11140 vsize=1051956 CPUtime=0.18
/proc/11143/task/11145/stat : 11145 (java) S 11140 11140 1750 0 -1 4202560 8739 0 0 0 16 2 0 0 20 0 10 0 117457236 1077202944 71446 18446744073709551615 4194304 4228012 140734153947616 140703183416448 140703284258379 0 0 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11146] ppid=11140 vsize=1051956 CPUtime=0
/proc/11143/task/11146/stat : 11146 (java) S 11140 11140 1750 0 -1 4202560 16 0 0 0 0 0 0 0 20 0 10 0 117457237 1077202944 71446 18446744073709551615 4194304 4228012 140734153947616 140703182362640 140703284257492 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11147] ppid=11140 vsize=1051956 CPUtime=0
/proc/11143/task/11147/stat : 11147 (java) S 11140 11140 1750 0 -1 4202560 8 0 0 0 0 0 0 0 20 0 10 0 117457237 1077202944 71446 18446744073709551615 4194304 4228012 140734153947616 140703181309856 140703284257492 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11148] ppid=11140 vsize=1051956 CPUtime=0
/proc/11143/task/11148/stat : 11148 (java) S 11140 11140 1750 0 -1 4202560 0 0 0 0 0 0 0 0 20 0 10 0 117457240 1077202944 71446 18446744073709551615 4194304 4228012 140734153947616 140703180258288 140703284266016 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11149] ppid=11140 vsize=1051956 CPUtime=0.66
/proc/11143/task/11149/stat : 11149 (java) S 11140 11140 1750 0 -1 4202560 11077 0 0 0 63 3 0 0 20 0 10 0 117457240 1077202944 71446 18446744073709551615 4194304 4228012 140734153947616 140703179205648 140703284257492 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11150] ppid=11140 vsize=1051956 CPUtime=0.64
/proc/11143/task/11150/stat : 11150 (java) S 11140 11140 1750 0 -1 4202560 7411 0 0 0 61 3 0 0 20 0 10 0 117457240 1077202944 71446 18446744073709551615 4194304 4228012 140734153947616 140703178152976 140703284257492 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11151] ppid=11140 vsize=1051956 CPUtime=0
/proc/11143/task/11151/stat : 11151 (java) S 11140 11140 1750 0 -1 4202560 0 0 0 0 0 0 0 0 20 0 10 0 117457241 1077202944 71446 18446744073709551615 4194304 4228012 140734153947616 140703177100496 140703284257492 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11152] ppid=11140 vsize=1051956 CPUtime=0
/proc/11143/task/11152/stat : 11152 (java) S 11140 11140 1750 0 -1 4202560 0 0 0 0 0 0 0 0 20 0 10 0 117457241 1077202944 71446 18446744073709551615 4194304 4228012 140734153947616 140703176048000 140703284258379 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
Current children cumulated CPU time (s) 2.96
Current children cumulated vsize (KiB) 1061128

[startup+6.3008 s]
/proc/loadavg: 1.32 1.12 1.03 2/70 11152
/proc/meminfo: memFree=221332/1022884 swapFree=0/0
[pid=11140] ppid=11139 vsize=9172 CPUtime=0
/proc/11140/stat : 11140 (p2cudf-full-1.1) S 11139 11140 1750 0 -1 4202496 461 292 0 0 0 0 0 0 20 0 1 0 117457224 9392128 332 18446744073709551615 4194304 5129932 140736239593776 140736239591920 140438281552990 0 65536 16781316 65538 0 0 0 17 0 0 0 0 0 0
/proc/11140/statm: 2293 332 280 229 0 53 0
[pid=11143] ppid=11140 vsize=1051956 CPUtime=6.07
/proc/11143/stat : 11143 (java) S 11140 11140 1750 0 -1 4202496 99629 0 15 0 571 36 0 0 20 0 10 0 117457225 1077202944 94809 18446744073709551615 4194304 4228012 140734153947616 140734153938640 140703284244085 0 0 0 16800975 18446744073709551615 0 0 17 0 0 0 6 0 0
/proc/11143/statm: 262989 94809 2374 9 0 250339 0
[pid=11143/tid=11144] ppid=11140 vsize=1051956 CPUtime=2.89
/proc/11143/task/11144/stat : 11144 (java) R 11140 11140 1750 0 -1 4202560 47726 0 3 0 270 19 0 0 20 0 10 0 117457232 1077202944 94809 18446744073709551615 4194304 4228012 140734153947616 140703290778072 140703267739075 0 4 0 16800975 0 0 0 -1 0 0 0 6 0 0
[pid=11143/tid=11145] ppid=11140 vsize=1051956 CPUtime=0.69
/proc/11143/task/11145/stat : 11145 (java) S 11140 11140 1750 0 -1 4202560 31549 0 0 0 60 9 0 0 20 0 10 0 117457236 1077202944 94809 18446744073709551615 4194304 4228012 140734153947616 140703183416448 140703284258379 0 0 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11146] ppid=11140 vsize=1051956 CPUtime=0
/proc/11143/task/11146/stat : 11146 (java) S 11140 11140 1750 0 -1 4202560 16 0 0 0 0 0 0 0 20 0 10 0 117457237 1077202944 94809 18446744073709551615 4194304 4228012 140734153947616 140703182362640 140703284257492 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11147] ppid=11140 vsize=1051956 CPUtime=0
/proc/11143/task/11147/stat : 11147 (java) S 11140 11140 1750 0 -1 4202560 8 0 0 0 0 0 0 0 20 0 10 0 117457237 1077202944 94809 18446744073709551615 4194304 4228012 140734153947616 140703181309856 140703284257492 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11148] ppid=11140 vsize=1051956 CPUtime=0
/proc/11143/task/11148/stat : 11148 (java) S 11140 11140 1750 0 -1 4202560 0 0 0 0 0 0 0 0 20 0 10 0 117457240 1077202944 94809 18446744073709551615 4194304 4228012 140734153947616 140703180258288 140703284266016 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11149] ppid=11140 vsize=1051956 CPUtime=1.26
/proc/11143/task/11149/stat : 11149 (java) R 11140 11140 1750 0 -1 4202560 11624 0 0 0 122 4 0 0 20 0 10 0 117457240 1077202944 94809 18446744073709551615 4194304 4228012 140734153947616 140703179205392 140703268518135 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11150] ppid=11140 vsize=1051956 CPUtime=1.19
/proc/11143/task/11150/stat : 11150 (java) R 11140 11140 1750 0 -1 4202560 7452 0 0 0 116 3 0 0 20 0 10 0 117457240 1077202944 94809 18446744073709551615 4194304 4228012 140734153947616 140703178152720 140703268075078 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11151] ppid=11140 vsize=1051956 CPUtime=0
/proc/11143/task/11151/stat : 11151 (java) S 11140 11140 1750 0 -1 4202560 0 0 0 0 0 0 0 0 20 0 10 0 117457241 1077202944 94809 18446744073709551615 4194304 4228012 140734153947616 140703177100496 140703284257492 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11152] ppid=11140 vsize=1051956 CPUtime=0
/proc/11143/task/11152/stat : 11152 (java) S 11140 11140 1750 0 -1 4202560 0 0 0 0 0 0 0 0 20 0 10 0 117457241 1077202944 94809 18446744073709551615 4194304 4228012 140734153947616 140703176048000 140703284258379 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
Current children cumulated CPU time (s) 6.07
Current children cumulated vsize (KiB) 1061128

[startup+12.7009 s]
/proc/loadavg: 1.41 1.14 1.04 2/71 11153
/proc/meminfo: memFree=180032/1022884 swapFree=0/0
[pid=11140] ppid=11139 vsize=9172 CPUtime=0
/proc/11140/stat : 11140 (p2cudf-full-1.1) S 11139 11140 1750 0 -1 4202496 461 292 0 0 0 0 0 0 20 0 1 0 117457224 9392128 332 18446744073709551615 4194304 5129932 140736239593776 140736239591920 140438281552990 0 65536 16781316 65538 0 0 0 17 0 0 0 0 0 0
/proc/11140/statm: 2293 332 280 229 0 53 0
[pid=11143] ppid=11140 vsize=1049612 CPUtime=12.38
/proc/11143/stat : 11143 (java) S 11140 11140 1750 0 -1 4202496 110541 0 15 0 1198 40 0 0 20 0 11 0 117457225 1074802688 104855 18446744073709551615 4194304 4228012 140734153947616 140734153938640 140703284244085 0 0 0 16800975 18446744073709551615 0 0 17 0 0 0 6 0 0
/proc/11143/statm: 262403 104855 2393 9 0 249753 0
[pid=11143/tid=11144] ppid=11140 vsize=1049612 CPUtime=6.38
/proc/11143/task/11144/stat : 11144 (java) R 11140 11140 1750 0 -1 4202560 47823 0 3 0 618 20 0 0 20 0 11 0 117457232 1074802688 104855 18446744073709551615 4194304 4228012 140734153947616 140703290777464 140703189139860 0 4 0 16800975 0 0 0 -1 0 0 0 6 0 0
[pid=11143/tid=11145] ppid=11140 vsize=1049612 CPUtime=1.34
/proc/11143/task/11145/stat : 11145 (java) S 11140 11140 1750 0 -1 4202560 42175 0 0 0 122 12 0 0 20 0 11 0 117457236 1074802688 104855 18446744073709551615 4194304 4228012 140734153947616 140703183416448 140703284258379 0 0 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11146] ppid=11140 vsize=1049612 CPUtime=0
/proc/11143/task/11146/stat : 11146 (java) S 11140 11140 1750 0 -1 4202560 16 0 0 0 0 0 0 0 20 0 11 0 117457237 1074802688 104855 18446744073709551615 4194304 4228012 140734153947616 140703182362640 140703284257492 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11147] ppid=11140 vsize=1049612 CPUtime=0
/proc/11143/task/11147/stat : 11147 (java) S 11140 11140 1750 0 -1 4202560 8 0 0 0 0 0 0 0 20 0 11 0 117457237 1074802688 104855 18446744073709551615 4194304 4228012 140734153947616 140703181309856 140703284257492 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11148] ppid=11140 vsize=1049612 CPUtime=0
/proc/11143/task/11148/stat : 11148 (java) S 11140 11140 1750 0 -1 4202560 0 0 0 0 0 0 0 0 20 0 11 0 117457240 1074802688 104855 18446744073709551615 4194304 4228012 140734153947616 140703180258288 140703284266016 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11149] ppid=11140 vsize=1049612 CPUtime=2.31
/proc/11143/task/11149/stat : 11149 (java) S 11140 11140 1750 0 -1 4202560 11739 0 0 0 227 4 0 0 20 0 11 0 117457240 1074802688 104855 18446744073709551615 4194304 4228012 140734153947616 140703179205648 140703284257492 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11150] ppid=11140 vsize=1049612 CPUtime=2.31
/proc/11143/task/11150/stat : 11150 (java) S 11140 11140 1750 0 -1 4202560 7520 0 0 0 228 3 0 0 20 0 11 0 117457240 1074802688 104855 18446744073709551615 4194304 4228012 140734153947616 140703178152976 140703284257492 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11151] ppid=11140 vsize=1049612 CPUtime=0
/proc/11143/task/11151/stat : 11151 (java) S 11140 11140 1750 0 -1 4202560 0 0 0 0 0 0 0 0 20 0 11 0 117457241 1074802688 104855 18446744073709551615 4194304 4228012 140734153947616 140703177100496 140703284257492 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11152] ppid=11140 vsize=1049612 CPUtime=0
/proc/11143/task/11152/stat : 11152 (java) S 11140 11140 1750 0 -1 4202560 0 0 0 0 0 0 0 0 20 0 11 0 117457241 1074802688 104855 18446744073709551615 4194304 4228012 140734153947616 140703176048000 140703284258379 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11153] ppid=11140 vsize=1049612 CPUtime=0
/proc/11143/task/11153/stat : 11153 (java) S 11140 11140 1750 0 -1 4202560 6 0 0 0 0 0 0 0 20 0 11 0 117458052 1074802688 104855 18446744073709551615 4194304 4228012 140734153947616 140703174850400 140703284258379 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
Current children cumulated CPU time (s) 12.38
Current children cumulated vsize (KiB) 1058784

[startup+25.5009 s]
/proc/loadavg: 1.35 1.14 1.04 2/71 11153
/proc/meminfo: memFree=156720/1022884 swapFree=0/0
[pid=11140] ppid=11139 vsize=9172 CPUtime=0
/proc/11140/stat : 11140 (p2cudf-full-1.1) S 11139 11140 1750 0 -1 4202496 461 292 0 0 0 0 0 0 20 0 1 0 117457224 9392128 332 18446744073709551615 4194304 5129932 140736239593776 140736239591920 140438281552990 0 65536 16781316 65538 0 0 0 17 0 0 0 0 0 0
/proc/11140/statm: 2293 332 280 229 0 53 0
[pid=11143] ppid=11140 vsize=1049612 CPUtime=25
/proc/11143/stat : 11143 (java) S 11140 11140 1750 0 -1 4202496 116318 0 15 0 2458 42 0 0 20 0 11 0 117457225 1074802688 110632 18446744073709551615 4194304 4228012 140734153947616 140734153938640 140703284244085 0 0 0 16800975 18446744073709551615 0 0 17 0 0 0 6 0 0
/proc/11143/statm: 262403 110632 2393 9 0 249753 0
[pid=11143/tid=11144] ppid=11140 vsize=1049612 CPUtime=16.09
/proc/11143/task/11144/stat : 11144 (java) R 11140 11140 1750 0 -1 4202560 47824 0 3 0 1589 20 0 0 20 0 11 0 117457232 1074802688 110632 18446744073709551615 4194304 4228012 140734153947616 140703290777560 140703189052789 0 4 0 16800975 0 0 0 -1 0 0 0 6 0 0
[pid=11143/tid=11145] ppid=11140 vsize=1049612 CPUtime=4.13
/proc/11143/task/11145/stat : 11145 (java) S 11140 11140 1750 0 -1 4202560 47951 0 0 0 399 14 0 0 20 0 11 0 117457236 1074802688 110632 18446744073709551615 4194304 4228012 140734153947616 140703183416448 140703284258379 0 0 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11146] ppid=11140 vsize=1049612 CPUtime=0
/proc/11143/task/11146/stat : 11146 (java) S 11140 11140 1750 0 -1 4202560 16 0 0 0 0 0 0 0 20 0 11 0 117457237 1074802688 110632 18446744073709551615 4194304 4228012 140734153947616 140703182362640 140703284257492 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11147] ppid=11140 vsize=1049612 CPUtime=0
/proc/11143/task/11147/stat : 11147 (java) S 11140 11140 1750 0 -1 4202560 8 0 0 0 0 0 0 0 20 0 11 0 117457237 1074802688 110632 18446744073709551615 4194304 4228012 140734153947616 140703181309856 140703284257492 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11148] ppid=11140 vsize=1049612 CPUtime=0
/proc/11143/task/11148/stat : 11148 (java) S 11140 11140 1750 0 -1 4202560 0 0 0 0 0 0 0 0 20 0 11 0 117457240 1074802688 110632 18446744073709551615 4194304 4228012 140734153947616 140703180258288 140703284266016 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11149] ppid=11140 vsize=1049612 CPUtime=2.4
/proc/11143/task/11149/stat : 11149 (java) S 11140 11140 1750 0 -1 4202560 11739 0 0 0 236 4 0 0 20 0 11 0 117457240 1074802688 110632 18446744073709551615 4194304 4228012 140734153947616 140703179205648 140703284257492 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11150] ppid=11140 vsize=1049612 CPUtime=2.35
/proc/11143/task/11150/stat : 11150 (java) S 11140 11140 1750 0 -1 4202560 7520 0 0 0 232 3 0 0 20 0 11 0 117457240 1074802688 110632 18446744073709551615 4194304 4228012 140734153947616 140703178152976 140703284257492 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11151] ppid=11140 vsize=1049612 CPUtime=0
/proc/11143/task/11151/stat : 11151 (java) S 11140 11140 1750 0 -1 4202560 0 0 0 0 0 0 0 0 20 0 11 0 117457241 1074802688 110632 18446744073709551615 4194304 4228012 140734153947616 140703177100496 140703284257492 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11152] ppid=11140 vsize=1049612 CPUtime=0.01
/proc/11143/task/11152/stat : 11152 (java) S 11140 11140 1750 0 -1 4202560 0 0 0 0 0 1 0 0 20 0 11 0 117457241 1074802688 110632 18446744073709551615 4194304 4228012 140734153947616 140703176048000 140703284258379 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11153] ppid=11140 vsize=1049612 CPUtime=0
/proc/11143/task/11153/stat : 11153 (java) S 11140 11140 1750 0 -1 4202560 6 0 0 0 0 0 0 0 20 0 11 0 117458052 1074802688 110632 18446744073709551615 4194304 4228012 140734153947616 140703174850400 140703284258379 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
Current children cumulated CPU time (s) 25
Current children cumulated vsize (KiB) 1058784

[startup+51.1006 s]
/proc/loadavg: 1.23 1.13 1.03 2/71 11153
/proc/meminfo: memFree=141964/1022884 swapFree=0/0
[pid=11140] ppid=11139 vsize=9172 CPUtime=0
/proc/11140/stat : 11140 (p2cudf-full-1.1) S 11139 11140 1750 0 -1 4202496 461 292 0 0 0 0 0 0 20 0 1 0 117457224 9392128 332 18446744073709551615 4194304 5129932 140736239593776 140736239591920 140438281552990 0 65536 16781316 65538 0 0 0 17 0 0 0 0 0 0
/proc/11140/statm: 2293 332 280 229 0 53 0
[pid=11143] ppid=11140 vsize=1049612 CPUtime=50.29
/proc/11143/stat : 11143 (java) S 11140 11140 1750 0 -1 4202496 119994 0 15 0 4986 43 0 0 20 0 11 0 117457225 1074802688 114304 18446744073709551615 4194304 4228012 140734153947616 140734153938640 140703284244085 0 0 0 16800975 18446744073709551615 0 0 17 0 0 0 6 0 0
/proc/11143/statm: 262403 114304 2393 9 0 249753 0
[pid=11143/tid=11144] ppid=11140 vsize=1049612 CPUtime=37.96
/proc/11143/task/11144/stat : 11144 (java) R 11140 11140 1750 0 -1 4202560 47824 0 3 0 3776 20 0 0 20 0 11 0 117457232 1074802688 114304 18446744073709551615 4194304 4228012 140734153947616 140703290777560 140703189618371 0 4 0 16800975 0 0 0 -1 0 0 0 6 0 0
[pid=11143/tid=11145] ppid=11140 vsize=1049612 CPUtime=7.53
/proc/11143/task/11145/stat : 11145 (java) S 11140 11140 1750 0 -1 4202560 51624 0 0 0 739 14 0 0 20 0 11 0 117457236 1074802688 114304 18446744073709551615 4194304 4228012 140734153947616 140703183416448 140703284258379 0 0 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11146] ppid=11140 vsize=1049612 CPUtime=0
/proc/11143/task/11146/stat : 11146 (java) S 11140 11140 1750 0 -1 4202560 16 0 0 0 0 0 0 0 20 0 11 0 117457237 1074802688 114304 18446744073709551615 4194304 4228012 140734153947616 140703182362640 140703284257492 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11147] ppid=11140 vsize=1049612 CPUtime=0
/proc/11143/task/11147/stat : 11147 (java) S 11140 11140 1750 0 -1 4202560 8 0 0 0 0 0 0 0 20 0 11 0 117457237 1074802688 114304 18446744073709551615 4194304 4228012 140734153947616 140703181309856 140703284257492 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11148] ppid=11140 vsize=1049612 CPUtime=0
/proc/11143/task/11148/stat : 11148 (java) S 11140 11140 1750 0 -1 4202560 0 0 0 0 0 0 0 0 20 0 11 0 117457240 1074802688 114304 18446744073709551615 4194304 4228012 140734153947616 140703180258288 140703284266016 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11149] ppid=11140 vsize=1049612 CPUtime=2.4
/proc/11143/task/11149/stat : 11149 (java) S 11140 11140 1750 0 -1 4202560 11739 0 0 0 236 4 0 0 20 0 11 0 117457240 1074802688 114304 18446744073709551615 4194304 4228012 140734153947616 140703179205648 140703284257492 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11150] ppid=11140 vsize=1049612 CPUtime=2.35
/proc/11143/task/11150/stat : 11150 (java) S 11140 11140 1750 0 -1 4202560 7520 0 0 0 232 3 0 0 20 0 11 0 117457240 1074802688 114304 18446744073709551615 4194304 4228012 140734153947616 140703178152976 140703284257492 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11151] ppid=11140 vsize=1049612 CPUtime=0
/proc/11143/task/11151/stat : 11151 (java) S 11140 11140 1750 0 -1 4202560 0 0 0 0 0 0 0 0 20 0 11 0 117457241 1074802688 114304 18446744073709551615 4194304 4228012 140734153947616 140703177100496 140703284257492 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11152] ppid=11140 vsize=1049612 CPUtime=0.02
/proc/11143/task/11152/stat : 11152 (java) S 11140 11140 1750 0 -1 4202560 3 0 0 0 0 2 0 0 20 0 11 0 117457241 1074802688 114304 18446744073709551615 4194304 4228012 140734153947616 140703176048000 140703284258379 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11153] ppid=11140 vsize=1049612 CPUtime=0
/proc/11143/task/11153/stat : 11153 (java) S 11140 11140 1750 0 -1 4202560 6 0 0 0 0 0 0 0 20 0 11 0 117458052 1074802688 114304 18446744073709551615 4194304 4228012 140734153947616 140703174850400 140703284258379 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
Current children cumulated CPU time (s) 50.29
Current children cumulated vsize (KiB) 1058784

[startup+102.301 s]
/proc/loadavg: 1.12 1.12 1.03 2/71 11153
/proc/meminfo: memFree=116668/1022884 swapFree=0/0
[pid=11140] ppid=11139 vsize=9172 CPUtime=0
/proc/11140/stat : 11140 (p2cudf-full-1.1) S 11139 11140 1750 0 -1 4202496 461 292 0 0 0 0 0 0 20 0 1 0 117457224 9392128 332 18446744073709551615 4194304 5129932 140736239593776 140736239591920 140438281552990 0 65536 16781316 65538 0 0 0 17 0 0 0 0 0 0
/proc/11140/statm: 2293 332 280 229 0 53 0
[pid=11143] ppid=11140 vsize=1049612 CPUtime=100.89
/proc/11143/stat : 11143 (java) S 11140 11140 1750 0 -1 4202496 126260 0 15 0 10045 44 0 0 20 0 11 0 117457225 1074802688 120562 18446744073709551615 4194304 4228012 140734153947616 140734153938640 140703284244085 0 0 0 16800975 18446744073709551615 0 0 17 0 0 0 6 0 0
/proc/11143/statm: 262403 120562 2393 9 0 249753 0
[pid=11143/tid=11144] ppid=11140 vsize=1049612 CPUtime=83.99
/proc/11143/task/11144/stat : 11144 (java) R 11140 11140 1750 0 -1 4202560 47824 0 3 0 8379 20 0 0 20 0 11 0 117457232 1074802688 120562 18446744073709551615 4194304 4228012 140734153947616 140703290777560 140703189641275 0 4 0 16800975 0 0 0 -1 0 0 0 9 0 0
[pid=11143/tid=11145] ppid=11140 vsize=1049612 CPUtime=12.01
/proc/11143/task/11145/stat : 11145 (java) S 11140 11140 1750 0 -1 4202560 57884 0 0 0 1185 16 0 0 20 0 11 0 117457236 1074802688 120562 18446744073709551615 4194304 4228012 140734153947616 140703183416448 140703284258379 0 0 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11146] ppid=11140 vsize=1049612 CPUtime=0
/proc/11143/task/11146/stat : 11146 (java) S 11140 11140 1750 0 -1 4202560 16 0 0 0 0 0 0 0 20 0 11 0 117457237 1074802688 120562 18446744073709551615 4194304 4228012 140734153947616 140703182362640 140703284257492 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11147] ppid=11140 vsize=1049612 CPUtime=0
/proc/11143/task/11147/stat : 11147 (java) S 11140 11140 1750 0 -1 4202560 8 0 0 0 0 0 0 0 20 0 11 0 117457237 1074802688 120562 18446744073709551615 4194304 4228012 140734153947616 140703181309856 140703284257492 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11148] ppid=11140 vsize=1049612 CPUtime=0
/proc/11143/task/11148/stat : 11148 (java) S 11140 11140 1750 0 -1 4202560 0 0 0 0 0 0 0 0 20 0 11 0 117457240 1074802688 120562 18446744073709551615 4194304 4228012 140734153947616 140703180258288 140703284266016 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11149] ppid=11140 vsize=1049612 CPUtime=2.42
/proc/11143/task/11149/stat : 11149 (java) S 11140 11140 1750 0 -1 4202560 11739 0 0 0 238 4 0 0 20 0 11 0 117457240 1074802688 120562 18446744073709551615 4194304 4228012 140734153947616 140703179205648 140703284257492 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11150] ppid=11140 vsize=1049612 CPUtime=2.39
/proc/11143/task/11150/stat : 11150 (java) S 11140 11140 1750 0 -1 4202560 7520 0 0 0 236 3 0 0 20 0 11 0 117457240 1074802688 120562 18446744073709551615 4194304 4228012 140734153947616 140703178152976 140703284257492 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11151] ppid=11140 vsize=1049612 CPUtime=0
/proc/11143/task/11151/stat : 11151 (java) S 11140 11140 1750 0 -1 4202560 0 0 0 0 0 0 0 0 20 0 11 0 117457241 1074802688 120562 18446744073709551615 4194304 4228012 140734153947616 140703177100496 140703284257492 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11152] ppid=11140 vsize=1049612 CPUtime=0.04
/proc/11143/task/11152/stat : 11152 (java) S 11140 11140 1750 0 -1 4202560 9 0 0 0 0 4 0 0 20 0 11 0 117457241 1074802688 120562 18446744073709551615 4194304 4228012 140734153947616 140703176048000 140703284258379 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11153] ppid=11140 vsize=1049612 CPUtime=0
/proc/11143/task/11153/stat : 11153 (java) S 11140 11140 1750 0 -1 4202560 6 0 0 0 0 0 0 0 20 0 11 0 117458052 1074802688 120562 18446744073709551615 4194304 4228012 140734153947616 140703174850400 140703284258379 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
Current children cumulated CPU time (s) 100.89
Current children cumulated vsize (KiB) 1058784

[startup+162.301 s]
/proc/loadavg: 1.05 1.10 1.03 2/71 11153
/proc/meminfo: memFree=101416/1022884 swapFree=0/0
[pid=11140] ppid=11139 vsize=9172 CPUtime=0
/proc/11140/stat : 11140 (p2cudf-full-1.1) S 11139 11140 1750 0 -1 4202496 461 292 0 0 0 0 0 0 20 0 1 0 117457224 9392128 332 18446744073709551615 4194304 5129932 140736239593776 140736239591920 140438281552990 0 65536 16781316 65538 0 0 0 17 0 0 0 0 0 0
/proc/11140/statm: 2293 332 280 229 0 53 0
[pid=11143] ppid=11140 vsize=1049612 CPUtime=160.14
/proc/11143/stat : 11143 (java) S 11140 11140 1750 0 -1 4202496 130051 0 15 0 15968 46 0 0 20 0 11 0 117457225 1074802688 124349 18446744073709551615 4194304 4228012 140734153947616 140734153938640 140703284244085 0 0 0 16800975 18446744073709551615 0 0 17 0 0 0 6 0 0
/proc/11143/statm: 262403 124349 2393 9 0 249753 0
[pid=11143/tid=11144] ppid=11140 vsize=1049612 CPUtime=139.38
/proc/11143/task/11144/stat : 11144 (java) R 11140 11140 1750 0 -1 4202560 47824 0 3 0 13918 20 0 0 20 0 11 0 117457232 1074802688 124349 18446744073709551615 4194304 4228012 140734153947616 140703290777560 140703189083629 0 4 0 16800975 0 0 0 -1 0 0 0 10 0 0
[pid=11143/tid=11145] ppid=11140 vsize=1049612 CPUtime=15.84
/proc/11143/task/11145/stat : 11145 (java) S 11140 11140 1750 0 -1 4202560 61672 0 0 0 1566 18 0 0 20 0 11 0 117457236 1074802688 124349 18446744073709551615 4194304 4228012 140734153947616 140703183416448 140703284258379 0 0 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11146] ppid=11140 vsize=1049612 CPUtime=0
/proc/11143/task/11146/stat : 11146 (java) S 11140 11140 1750 0 -1 4202560 16 0 0 0 0 0 0 0 20 0 11 0 117457237 1074802688 124349 18446744073709551615 4194304 4228012 140734153947616 140703182362640 140703284257492 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11147] ppid=11140 vsize=1049612 CPUtime=0
/proc/11143/task/11147/stat : 11147 (java) S 11140 11140 1750 0 -1 4202560 8 0 0 0 0 0 0 0 20 0 11 0 117457237 1074802688 124349 18446744073709551615 4194304 4228012 140734153947616 140703181309856 140703284257492 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11148] ppid=11140 vsize=1049612 CPUtime=0
/proc/11143/task/11148/stat : 11148 (java) S 11140 11140 1750 0 -1 4202560 0 0 0 0 0 0 0 0 20 0 11 0 117457240 1074802688 124349 18446744073709551615 4194304 4228012 140734153947616 140703180258288 140703284266016 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11149] ppid=11140 vsize=1049612 CPUtime=2.42
/proc/11143/task/11149/stat : 11149 (java) S 11140 11140 1750 0 -1 4202560 11739 0 0 0 238 4 0 0 20 0 11 0 117457240 1074802688 124349 18446744073709551615 4194304 4228012 140734153947616 140703179205648 140703284257492 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11150] ppid=11140 vsize=1049612 CPUtime=2.39
/proc/11143/task/11150/stat : 11150 (java) S 11140 11140 1750 0 -1 4202560 7520 0 0 0 236 3 0 0 20 0 11 0 117457240 1074802688 124349 18446744073709551615 4194304 4228012 140734153947616 140703178152976 140703284257492 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11151] ppid=11140 vsize=1049612 CPUtime=0
/proc/11143/task/11151/stat : 11151 (java) S 11140 11140 1750 0 -1 4202560 0 0 0 0 0 0 0 0 20 0 11 0 117457241 1074802688 124349 18446744073709551615 4194304 4228012 140734153947616 140703177100496 140703284257492 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11152] ppid=11140 vsize=1049612 CPUtime=0.07
/proc/11143/task/11152/stat : 11152 (java) S 11140 11140 1750 0 -1 4202560 12 0 0 0 0 7 0 0 20 0 11 0 117457241 1074802688 124349 18446744073709551615 4194304 4228012 140734153947616 140703176048000 140703284258379 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11153] ppid=11140 vsize=1049612 CPUtime=0
/proc/11143/task/11153/stat : 11153 (java) S 11140 11140 1750 0 -1 4202560 6 0 0 0 0 0 0 0 20 0 11 0 117458052 1074802688 124349 18446744073709551615 4194304 4228012 140734153947616 140703174850400 140703284258379 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
Current children cumulated CPU time (s) 160.14
Current children cumulated vsize (KiB) 1058784

[startup+222.305 s]
/proc/loadavg: 1.05 1.09 1.03 2/71 11153
/proc/meminfo: memFree=97944/1022884 swapFree=0/0
[pid=11140] ppid=11139 vsize=9172 CPUtime=0
/proc/11140/stat : 11140 (p2cudf-full-1.1) S 11139 11140 1750 0 -1 4202496 461 292 0 0 0 0 0 0 20 0 1 0 117457224 9392128 332 18446744073709551615 4194304 5129932 140736239593776 140736239591920 140438281552990 0 65536 16781316 65538 0 0 0 17 0 0 0 0 0 0
/proc/11140/statm: 2293 332 280 229 0 53 0
[pid=11143] ppid=11140 vsize=1049612 CPUtime=219.3
/proc/11143/stat : 11143 (java) S 11140 11140 1750 0 -1 4202496 130928 0 15 0 21884 46 0 0 20 0 11 0 117457225 1074802688 125218 18446744073709551615 4194304 4228012 140734153947616 140734153938640 140703284244085 0 0 0 16800975 18446744073709551615 0 0 17 0 0 0 6 0 0
/proc/11143/statm: 262403 125218 2393 9 0 249753 0
[pid=11143/tid=11144] ppid=11140 vsize=1049612 CPUtime=195.49
/proc/11143/task/11144/stat : 11144 (java) R 11140 11140 1750 0 -1 4202560 47824 0 3 0 19529 20 0 0 20 0 11 0 117457232 1074802688 125218 18446744073709551615 4194304 4228012 140734153947616 140703290777560 140703189052748 0 4 0 16800975 0 0 0 -1 0 0 0 10 0 0
[pid=11143/tid=11145] ppid=11140 vsize=1049612 CPUtime=18.86
/proc/11143/task/11145/stat : 11145 (java) S 11140 11140 1750 0 -1 4202560 62543 0 0 0 1868 18 0 0 20 0 11 0 117457236 1074802688 125218 18446744073709551615 4194304 4228012 140734153947616 140703183416448 140703284258379 0 0 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11146] ppid=11140 vsize=1049612 CPUtime=0
/proc/11143/task/11146/stat : 11146 (java) S 11140 11140 1750 0 -1 4202560 16 0 0 0 0 0 0 0 20 0 11 0 117457237 1074802688 125218 18446744073709551615 4194304 4228012 140734153947616 140703182362640 140703284257492 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11147] ppid=11140 vsize=1049612 CPUtime=0
/proc/11143/task/11147/stat : 11147 (java) S 11140 11140 1750 0 -1 4202560 8 0 0 0 0 0 0 0 20 0 11 0 117457237 1074802688 125218 18446744073709551615 4194304 4228012 140734153947616 140703181309856 140703284257492 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11148] ppid=11140 vsize=1049612 CPUtime=0
/proc/11143/task/11148/stat : 11148 (java) S 11140 11140 1750 0 -1 4202560 0 0 0 0 0 0 0 0 20 0 11 0 117457240 1074802688 125218 18446744073709551615 4194304 4228012 140734153947616 140703180258288 140703284266016 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11149] ppid=11140 vsize=1049612 CPUtime=2.42
/proc/11143/task/11149/stat : 11149 (java) S 11140 11140 1750 0 -1 4202560 11739 0 0 0 238 4 0 0 20 0 11 0 117457240 1074802688 125218 18446744073709551615 4194304 4228012 140734153947616 140703179205648 140703284257492 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11150] ppid=11140 vsize=1049612 CPUtime=2.39
/proc/11143/task/11150/stat : 11150 (java) S 11140 11140 1750 0 -1 4202560 7520 0 0 0 236 3 0 0 20 0 11 0 117457240 1074802688 125218 18446744073709551615 4194304 4228012 140734153947616 140703178152976 140703284257492 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11151] ppid=11140 vsize=1049612 CPUtime=0
/proc/11143/task/11151/stat : 11151 (java) S 11140 11140 1750 0 -1 4202560 0 0 0 0 0 0 0 0 20 0 11 0 117457241 1074802688 125218 18446744073709551615 4194304 4228012 140734153947616 140703177100496 140703284257492 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11152] ppid=11140 vsize=1049612 CPUtime=0.1
/proc/11143/task/11152/stat : 11152 (java) S 11140 11140 1750 0 -1 4202560 18 0 0 0 0 10 0 0 20 0 11 0 117457241 1074802688 125218 18446744073709551615 4194304 4228012 140734153947616 140703176048000 140703284258379 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11153] ppid=11140 vsize=1049612 CPUtime=0
/proc/11143/task/11153/stat : 11153 (java) S 11140 11140 1750 0 -1 4202560 6 0 0 0 0 0 0 0 20 0 11 0 117458052 1074802688 125218 18446744073709551615 4194304 4228012 140734153947616 140703174850400 140703284258379 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
Current children cumulated CPU time (s) 219.3
Current children cumulated vsize (KiB) 1058784

[startup+282.301 s]
/proc/loadavg: 1.02 1.07 1.02 2/71 11153
/proc/meminfo: memFree=86412/1022884 swapFree=0/0
[pid=11140] ppid=11139 vsize=9172 CPUtime=0
/proc/11140/stat : 11140 (p2cudf-full-1.1) S 11139 11140 1750 0 -1 4202496 461 292 0 0 0 0 0 0 20 0 1 0 117457224 9392128 332 18446744073709551615 4194304 5129932 140736239593776 140736239591920 140438281552990 0 65536 16781316 65538 0 0 0 17 0 0 0 0 0 0
/proc/11140/statm: 2293 332 280 229 0 53 0
[pid=11143] ppid=11140 vsize=1049612 CPUtime=278.45
/proc/11143/stat : 11143 (java) S 11140 11140 1750 0 -1 4202496 133786 0 15 0 27797 48 0 0 20 0 11 0 117457225 1074802688 128069 18446744073709551615 4194304 4228012 140734153947616 140734153938640 140703284244085 0 0 0 16800975 18446744073709551615 0 0 17 0 0 0 6 0 0
/proc/11143/statm: 262403 128069 2393 9 0 249753 0
[pid=11143/tid=11144] ppid=11140 vsize=1049612 CPUtime=252.31
/proc/11143/task/11144/stat : 11144 (java) R 11140 11140 1750 0 -1 4202560 47824 0 3 0 25211 20 0 0 20 0 11 0 117457232 1074802688 128069 18446744073709551615 4194304 4228012 140734153947616 140703290777560 140703189584403 0 4 0 16800975 0 0 0 -1 0 0 0 10 0 0
[pid=11143/tid=11145] ppid=11140 vsize=1049612 CPUtime=21.15
/proc/11143/task/11145/stat : 11145 (java) S 11140 11140 1750 0 -1 4202560 65395 0 0 0 2096 19 0 0 20 0 11 0 117457236 1074802688 128069 18446744073709551615 4194304 4228012 140734153947616 140703183416448 140703284258379 0 0 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11146] ppid=11140 vsize=1049612 CPUtime=0
/proc/11143/task/11146/stat : 11146 (java) S 11140 11140 1750 0 -1 4202560 16 0 0 0 0 0 0 0 20 0 11 0 117457237 1074802688 128069 18446744073709551615 4194304 4228012 140734153947616 140703182362640 140703284257492 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11147] ppid=11140 vsize=1049612 CPUtime=0
/proc/11143/task/11147/stat : 11147 (java) S 11140 11140 1750 0 -1 4202560 8 0 0 0 0 0 0 0 20 0 11 0 117457237 1074802688 128069 18446744073709551615 4194304 4228012 140734153947616 140703181309856 140703284257492 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11148] ppid=11140 vsize=1049612 CPUtime=0
/proc/11143/task/11148/stat : 11148 (java) S 11140 11140 1750 0 -1 4202560 0 0 0 0 0 0 0 0 20 0 11 0 117457240 1074802688 128069 18446744073709551615 4194304 4228012 140734153947616 140703180258288 140703284266016 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11149] ppid=11140 vsize=1049612 CPUtime=2.42
/proc/11143/task/11149/stat : 11149 (java) S 11140 11140 1750 0 -1 4202560 11739 0 0 0 238 4 0 0 20 0 11 0 117457240 1074802688 128069 18446744073709551615 4194304 4228012 140734153947616 140703179205648 140703284257492 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11150] ppid=11140 vsize=1049612 CPUtime=2.39
/proc/11143/task/11150/stat : 11150 (java) S 11140 11140 1750 0 -1 4202560 7520 0 0 0 236 3 0 0 20 0 11 0 117457240 1074802688 128069 18446744073709551615 4194304 4228012 140734153947616 140703178152976 140703284257492 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11151] ppid=11140 vsize=1049612 CPUtime=0
/proc/11143/task/11151/stat : 11151 (java) S 11140 11140 1750 0 -1 4202560 0 0 0 0 0 0 0 0 20 0 11 0 117457241 1074802688 128069 18446744073709551615 4194304 4228012 140734153947616 140703177100496 140703284257492 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11152] ppid=11140 vsize=1049612 CPUtime=0.14
/proc/11143/task/11152/stat : 11152 (java) S 11140 11140 1750 0 -1 4202560 24 0 0 0 0 14 0 0 20 0 11 0 117457241 1074802688 128069 18446744073709551615 4194304 4228012 140734153947616 140703176048000 140703284258379 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11153] ppid=11140 vsize=1049612 CPUtime=0
/proc/11143/task/11153/stat : 11153 (java) S 11140 11140 1750 0 -1 4202560 6 0 0 0 0 0 0 0 20 0 11 0 117458052 1074802688 128069 18446744073709551615 4194304 4228012 140734153947616 140703174850400 140703284258379 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
Current children cumulated CPU time (s) 278.45
Current children cumulated vsize (KiB) 1058784

Solver just ended. Dumping a history of the last processes samples

[startup+288.001 s]
/proc/loadavg: 1.02 1.07 1.02 2/71 11153
/proc/meminfo: memFree=86412/1022884 swapFree=0/0
[pid=11140] ppid=11139 vsize=9172 CPUtime=0
/proc/11140/stat : 11140 (p2cudf-full-1.1) S 11139 11140 1750 0 -1 4202496 461 292 0 0 0 0 0 0 20 0 1 0 117457224 9392128 332 18446744073709551615 4194304 5129932 140736239593776 140736239591920 140438281552990 0 65536 16781316 65538 0 0 0 17 0 0 0 0 0 0
/proc/11140/statm: 2293 332 280 229 0 53 0
[pid=11143] ppid=11140 vsize=1049612 CPUtime=284.07
/proc/11143/stat : 11143 (java) S 11140 11140 1750 0 -1 4202496 133787 0 15 0 28359 48 0 0 20 0 11 0 117457225 1074802688 128069 18446744073709551615 4194304 4228012 140734153947616 140734153938640 140703284244085 0 0 0 16800975 18446744073709551615 0 0 17 0 0 0 6 0 0
/proc/11143/statm: 262403 128069 2393 9 0 249753 0
[pid=11143/tid=11144] ppid=11140 vsize=1049612 CPUtime=257.32
/proc/11143/task/11144/stat : 11144 (java) R 11140 11140 1750 0 -1 4202560 47824 0 3 0 25712 20 0 0 20 0 11 0 117457232 1074802688 128069 18446744073709551615 4194304 4228012 140734153947616 140703290777560 140703189680292 0 4 0 16800975 0 0 0 -1 0 0 0 10 0 0
[pid=11143/tid=11145] ppid=11140 vsize=1049612 CPUtime=21.76
/proc/11143/task/11145/stat : 11145 (java) S 11140 11140 1750 0 -1 4202560 65396 0 0 0 2157 19 0 0 20 0 11 0 117457236 1074802688 128069 18446744073709551615 4194304 4228012 140734153947616 140703183416448 140703284258379 0 0 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11146] ppid=11140 vsize=1049612 CPUtime=0
/proc/11143/task/11146/stat : 11146 (java) S 11140 11140 1750 0 -1 4202560 16 0 0 0 0 0 0 0 20 0 11 0 117457237 1074802688 128069 18446744073709551615 4194304 4228012 140734153947616 140703182362640 140703284257492 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11147] ppid=11140 vsize=1049612 CPUtime=0
/proc/11143/task/11147/stat : 11147 (java) S 11140 11140 1750 0 -1 4202560 8 0 0 0 0 0 0 0 20 0 11 0 117457237 1074802688 128069 18446744073709551615 4194304 4228012 140734153947616 140703181309856 140703284257492 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11148] ppid=11140 vsize=1049612 CPUtime=0
/proc/11143/task/11148/stat : 11148 (java) S 11140 11140 1750 0 -1 4202560 0 0 0 0 0 0 0 0 20 0 11 0 117457240 1074802688 128069 18446744073709551615 4194304 4228012 140734153947616 140703180258288 140703284266016 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11149] ppid=11140 vsize=1049612 CPUtime=2.42
/proc/11143/task/11149/stat : 11149 (java) S 11140 11140 1750 0 -1 4202560 11739 0 0 0 238 4 0 0 20 0 11 0 117457240 1074802688 128069 18446744073709551615 4194304 4228012 140734153947616 140703179205648 140703284257492 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11150] ppid=11140 vsize=1049612 CPUtime=2.39
/proc/11143/task/11150/stat : 11150 (java) S 11140 11140 1750 0 -1 4202560 7520 0 0 0 236 3 0 0 20 0 11 0 117457240 1074802688 128069 18446744073709551615 4194304 4228012 140734153947616 140703178152976 140703284257492 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11151] ppid=11140 vsize=1049612 CPUtime=0
/proc/11143/task/11151/stat : 11151 (java) S 11140 11140 1750 0 -1 4202560 0 0 0 0 0 0 0 0 20 0 11 0 117457241 1074802688 128069 18446744073709551615 4194304 4228012 140734153947616 140703177100496 140703284257492 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11152] ppid=11140 vsize=1049612 CPUtime=0.14
/proc/11143/task/11152/stat : 11152 (java) S 11140 11140 1750 0 -1 4202560 24 0 0 0 0 14 0 0 20 0 11 0 117457241 1074802688 128069 18446744073709551615 4194304 4228012 140734153947616 140703176048000 140703284258379 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11153] ppid=11140 vsize=1049612 CPUtime=0
/proc/11143/task/11153/stat : 11153 (java) S 11140 11140 1750 0 -1 4202560 6 0 0 0 0 0 0 0 20 0 11 0 117458052 1074802688 128069 18446744073709551615 4194304 4228012 140734153947616 140703174850400 140703284258379 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
Current children cumulated CPU time (s) 284.07
Current children cumulated vsize (KiB) 1058784

[startup+291.201 s]
/proc/loadavg: 1.02 1.07 1.02 2/71 11153
/proc/meminfo: memFree=86412/1022884 swapFree=0/0
[pid=11140] ppid=11139 vsize=9172 CPUtime=0
/proc/11140/stat : 11140 (p2cudf-full-1.1) S 11139 11140 1750 0 -1 4202496 461 292 0 0 0 0 0 0 20 0 1 0 117457224 9392128 332 18446744073709551615 4194304 5129932 140736239593776 140736239591920 140438281552990 0 65536 16781316 65538 0 0 0 17 0 0 0 0 0 0
/proc/11140/statm: 2293 332 280 229 0 53 0
[pid=11143] ppid=11140 vsize=1049612 CPUtime=287.22
/proc/11143/stat : 11143 (java) S 11140 11140 1750 0 -1 4202496 133787 0 15 0 28674 48 0 0 20 0 11 0 117457225 1074802688 128069 18446744073709551615 4194304 4228012 140734153947616 140734153938640 140703284244085 0 0 0 16800975 18446744073709551615 0 0 17 0 0 0 6 0 0
/proc/11143/statm: 262403 128069 2393 9 0 249753 0
[pid=11143/tid=11144] ppid=11140 vsize=1049612 CPUtime=260.47
/proc/11143/task/11144/stat : 11144 (java) R 11140 11140 1750 0 -1 4202560 47824 0 3 0 26027 20 0 0 20 0 11 0 117457232 1074802688 128069 18446744073709551615 4194304 4228012 140734153947616 140703290777560 140703189052784 0 4 0 16800975 0 0 0 -1 0 0 0 10 0 0
[pid=11143/tid=11145] ppid=11140 vsize=1049612 CPUtime=21.76
/proc/11143/task/11145/stat : 11145 (java) S 11140 11140 1750 0 -1 4202560 65396 0 0 0 2157 19 0 0 20 0 11 0 117457236 1074802688 128069 18446744073709551615 4194304 4228012 140734153947616 140703183416448 140703284258379 0 0 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11146] ppid=11140 vsize=1049612 CPUtime=0
/proc/11143/task/11146/stat : 11146 (java) S 11140 11140 1750 0 -1 4202560 16 0 0 0 0 0 0 0 20 0 11 0 117457237 1074802688 128069 18446744073709551615 4194304 4228012 140734153947616 140703182362640 140703284257492 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11147] ppid=11140 vsize=1049612 CPUtime=0
/proc/11143/task/11147/stat : 11147 (java) S 11140 11140 1750 0 -1 4202560 8 0 0 0 0 0 0 0 20 0 11 0 117457237 1074802688 128069 18446744073709551615 4194304 4228012 140734153947616 140703181309856 140703284257492 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11148] ppid=11140 vsize=1049612 CPUtime=0
/proc/11143/task/11148/stat : 11148 (java) S 11140 11140 1750 0 -1 4202560 0 0 0 0 0 0 0 0 20 0 11 0 117457240 1074802688 128069 18446744073709551615 4194304 4228012 140734153947616 140703180258288 140703284266016 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11149] ppid=11140 vsize=1049612 CPUtime=2.42
/proc/11143/task/11149/stat : 11149 (java) S 11140 11140 1750 0 -1 4202560 11739 0 0 0 238 4 0 0 20 0 11 0 117457240 1074802688 128069 18446744073709551615 4194304 4228012 140734153947616 140703179205648 140703284257492 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11150] ppid=11140 vsize=1049612 CPUtime=2.39
/proc/11143/task/11150/stat : 11150 (java) S 11140 11140 1750 0 -1 4202560 7520 0 0 0 236 3 0 0 20 0 11 0 117457240 1074802688 128069 18446744073709551615 4194304 4228012 140734153947616 140703178152976 140703284257492 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11151] ppid=11140 vsize=1049612 CPUtime=0
/proc/11143/task/11151/stat : 11151 (java) S 11140 11140 1750 0 -1 4202560 0 0 0 0 0 0 0 0 20 0 11 0 117457241 1074802688 128069 18446744073709551615 4194304 4228012 140734153947616 140703177100496 140703284257492 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11152] ppid=11140 vsize=1049612 CPUtime=0.14
/proc/11143/task/11152/stat : 11152 (java) S 11140 11140 1750 0 -1 4202560 24 0 0 0 0 14 0 0 20 0 11 0 117457241 1074802688 128069 18446744073709551615 4194304 4228012 140734153947616 140703176048000 140703284258379 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11153] ppid=11140 vsize=1049612 CPUtime=0
/proc/11143/task/11153/stat : 11153 (java) S 11140 11140 1750 0 -1 4202560 6 0 0 0 0 0 0 0 20 0 11 0 117458052 1074802688 128069 18446744073709551615 4194304 4228012 140734153947616 140703174850400 140703284258379 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
Current children cumulated CPU time (s) 287.22
Current children cumulated vsize (KiB) 1058784

[startup+292.801 s]
/proc/loadavg: 1.01 1.07 1.02 2/71 11153
/proc/meminfo: memFree=86412/1022884 swapFree=0/0
[pid=11140] ppid=11139 vsize=9172 CPUtime=0
/proc/11140/stat : 11140 (p2cudf-full-1.1) S 11139 11140 1750 0 -1 4202496 461 292 0 0 0 0 0 0 20 0 1 0 117457224 9392128 332 18446744073709551615 4194304 5129932 140736239593776 140736239591920 140438281552990 0 65536 16781316 65538 0 0 0 17 0 0 0 0 0 0
/proc/11140/statm: 2293 332 280 229 0 53 0
[pid=11143] ppid=11140 vsize=1049612 CPUtime=288.8
/proc/11143/stat : 11143 (java) S 11140 11140 1750 0 -1 4202496 133787 0 15 0 28832 48 0 0 20 0 11 0 117457225 1074802688 128069 18446744073709551615 4194304 4228012 140734153947616 140734153938640 140703284244085 0 0 0 16800975 18446744073709551615 0 0 17 0 0 0 6 0 0
/proc/11143/statm: 262403 128069 2393 9 0 249753 0
[pid=11143/tid=11144] ppid=11140 vsize=1049612 CPUtime=262.04
/proc/11143/task/11144/stat : 11144 (java) R 11140 11140 1750 0 -1 4202560 47824 0 3 0 26184 20 0 0 20 0 11 0 117457232 1074802688 128069 18446744073709551615 4194304 4228012 140734153947616 140703290777560 140703189052542 0 4 0 16800975 0 0 0 -1 0 0 0 10 0 0
[pid=11143/tid=11145] ppid=11140 vsize=1049612 CPUtime=21.76
/proc/11143/task/11145/stat : 11145 (java) S 11140 11140 1750 0 -1 4202560 65396 0 0 0 2157 19 0 0 20 0 11 0 117457236 1074802688 128069 18446744073709551615 4194304 4228012 140734153947616 140703183416448 140703284258379 0 0 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11146] ppid=11140 vsize=1049612 CPUtime=0
/proc/11143/task/11146/stat : 11146 (java) S 11140 11140 1750 0 -1 4202560 16 0 0 0 0 0 0 0 20 0 11 0 117457237 1074802688 128069 18446744073709551615 4194304 4228012 140734153947616 140703182362640 140703284257492 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11147] ppid=11140 vsize=1049612 CPUtime=0
/proc/11143/task/11147/stat : 11147 (java) S 11140 11140 1750 0 -1 4202560 8 0 0 0 0 0 0 0 20 0 11 0 117457237 1074802688 128069 18446744073709551615 4194304 4228012 140734153947616 140703181309856 140703284257492 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11148] ppid=11140 vsize=1049612 CPUtime=0
/proc/11143/task/11148/stat : 11148 (java) S 11140 11140 1750 0 -1 4202560 0 0 0 0 0 0 0 0 20 0 11 0 117457240 1074802688 128069 18446744073709551615 4194304 4228012 140734153947616 140703180258288 140703284266016 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11149] ppid=11140 vsize=1049612 CPUtime=2.42
/proc/11143/task/11149/stat : 11149 (java) S 11140 11140 1750 0 -1 4202560 11739 0 0 0 238 4 0 0 20 0 11 0 117457240 1074802688 128069 18446744073709551615 4194304 4228012 140734153947616 140703179205648 140703284257492 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11150] ppid=11140 vsize=1049612 CPUtime=2.39
/proc/11143/task/11150/stat : 11150 (java) S 11140 11140 1750 0 -1 4202560 7520 0 0 0 236 3 0 0 20 0 11 0 117457240 1074802688 128069 18446744073709551615 4194304 4228012 140734153947616 140703178152976 140703284257492 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11151] ppid=11140 vsize=1049612 CPUtime=0
/proc/11143/task/11151/stat : 11151 (java) S 11140 11140 1750 0 -1 4202560 0 0 0 0 0 0 0 0 20 0 11 0 117457241 1074802688 128069 18446744073709551615 4194304 4228012 140734153947616 140703177100496 140703284257492 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11152] ppid=11140 vsize=1049612 CPUtime=0.14
/proc/11143/task/11152/stat : 11152 (java) S 11140 11140 1750 0 -1 4202560 24 0 0 0 0 14 0 0 20 0 11 0 117457241 1074802688 128069 18446744073709551615 4194304 4228012 140734153947616 140703176048000 140703284258379 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11153] ppid=11140 vsize=1049612 CPUtime=0
/proc/11143/task/11153/stat : 11153 (java) S 11140 11140 1750 0 -1 4202560 6 0 0 0 0 0 0 0 20 0 11 0 117458052 1074802688 128069 18446744073709551615 4194304 4228012 140734153947616 140703174850400 140703284258379 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
Current children cumulated CPU time (s) 288.8
Current children cumulated vsize (KiB) 1058784

[startup+293.601 s]
/proc/loadavg: 1.01 1.07 1.02 2/71 11153
/proc/meminfo: memFree=86412/1022884 swapFree=0/0
[pid=11140] ppid=11139 vsize=9172 CPUtime=0
/proc/11140/stat : 11140 (p2cudf-full-1.1) S 11139 11140 1750 0 -1 4202496 461 292 0 0 0 0 0 0 20 0 1 0 117457224 9392128 332 18446744073709551615 4194304 5129932 140736239593776 140736239591920 140438281552990 0 65536 16781316 65538 0 0 0 17 0 0 0 0 0 0
/proc/11140/statm: 2293 332 280 229 0 53 0
[pid=11143] ppid=11140 vsize=1050640 CPUtime=289.32
/proc/11143/stat : 11143 (java) S 11140 11140 1750 0 -1 4202496 133799 0 15 0 28884 48 0 0 20 0 11 0 117457225 1075855360 128079 18446744073709551615 4194304 4228012 140734153947616 140734153938640 140703284244085 0 0 0 16800975 18446744073709551615 0 0 17 0 0 0 6 0 0
/proc/11143/statm: 262660 128079 2393 9 0 250010 0
[pid=11143/tid=11144] ppid=11140 vsize=1050640 CPUtime=262.55
/proc/11143/task/11144/stat : 11144 (java) S 11140 11140 1750 0 -1 4202560 47830 0 3 0 26235 20 0 0 20 0 11 0 117457232 1075855360 128079 18446744073709551615 4194304 4228012 140734153947616 140703290778544 140703284257492 0 4 0 16800975 0 0 0 -1 0 0 0 10 0 0
[pid=11143/tid=11145] ppid=11140 vsize=1050640 CPUtime=21.76
/proc/11143/task/11145/stat : 11145 (java) S 11140 11140 1750 0 -1 4202560 65396 0 0 0 2157 19 0 0 20 0 11 0 117457236 1075855360 128079 18446744073709551615 4194304 4228012 140734153947616 140703183416448 140703284258379 0 0 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11146] ppid=11140 vsize=1050640 CPUtime=0
/proc/11143/task/11146/stat : 11146 (java) S 11140 11140 1750 0 -1 4202560 16 0 0 0 0 0 0 0 20 0 11 0 117457237 1075855360 128079 18446744073709551615 4194304 4228012 140734153947616 140703182362640 140703284257492 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11147] ppid=11140 vsize=1050640 CPUtime=0
/proc/11143/task/11147/stat : 11147 (java) S 11140 11140 1750 0 -1 4202560 8 0 0 0 0 0 0 0 20 0 11 0 117457237 1075855360 128079 18446744073709551615 4194304 4228012 140734153947616 140703181309856 140703284257492 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11148] ppid=11140 vsize=1050640 CPUtime=0
/proc/11143/task/11148/stat : 11148 (java) S 11140 11140 1750 0 -1 4202560 0 0 0 0 0 0 0 0 20 0 11 0 117457240 1075855360 128079 18446744073709551615 4194304 4228012 140734153947616 140703180258288 140703284266016 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11149] ppid=11140 vsize=1050640 CPUtime=2.44
/proc/11143/task/11149/stat : 11149 (java) S 11140 11140 1750 0 -1 4202560 11739 0 0 0 240 4 0 0 20 0 11 0 117457240 1075855360 128079 18446744073709551615 4194304 4228012 140734153947616 140703179205648 140703284257492 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11150] ppid=11140 vsize=1050640 CPUtime=2.39
/proc/11143/task/11150/stat : 11150 (java) S 11140 11140 1750 0 -1 4202560 7520 0 0 0 236 3 0 0 20 0 11 0 117457240 1075855360 128079 18446744073709551615 4194304 4228012 140734153947616 140703178152976 140703284257492 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11151] ppid=11140 vsize=1050640 CPUtime=0
/proc/11143/task/11151/stat : 11151 (java) S 11140 11140 1750 0 -1 4202560 0 0 0 0 0 0 0 0 20 0 11 0 117457241 1075855360 128079 18446744073709551615 4194304 4228012 140734153947616 140703177100496 140703284257492 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11152] ppid=11140 vsize=1050640 CPUtime=0.14
/proc/11143/task/11152/stat : 11152 (java) S 11140 11140 1750 0 -1 4202560 24 0 0 0 0 14 0 0 20 0 11 0 117457241 1075855360 128079 18446744073709551615 4194304 4228012 140734153947616 140703176048000 140703284258379 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
Current children cumulated CPU time (s) 289.32
Current children cumulated vsize (KiB) 1059812

[startup+294.001 s]
/proc/loadavg: 1.01 1.07 1.02 1/71 11154
/proc/meminfo: memFree=86288/1022884 swapFree=0/0
[pid=11140] ppid=11139 vsize=9172 CPUtime=0
/proc/11140/stat : 11140 (p2cudf-full-1.1) S 11139 11140 1750 0 -1 4202496 461 292 0 0 0 0 0 0 20 0 1 0 117457224 9392128 332 18446744073709551615 4194304 5129932 140736239593776 140736239591920 140438281552990 0 65536 16781316 65538 0 0 0 17 0 0 0 0 0 0
/proc/11140/statm: 2293 332 280 229 0 53 0
[pid=11143] ppid=11140 vsize=1050640 CPUtime=289.5
/proc/11143/stat : 11143 (java) S 11140 11140 1750 0 -1 4202496 133803 0 15 0 28895 55 0 0 20 0 11 0 117457225 1075855360 128083 18446744073709551615 4194304 4228012 140734153947616 140734153938640 140703284244085 0 0 0 16800975 18446744073709551615 0 0 17 0 0 0 6 0 0
/proc/11143/statm: 262660 128083 2394 9 0 250010 0
[pid=11143/tid=11144] ppid=11140 vsize=1050640 CPUtime=262.55
/proc/11143/task/11144/stat : 11144 (java) S 11140 11140 1750 0 -1 4202560 47830 0 3 0 26235 20 0 0 20 0 11 0 117457232 1075855360 128083 18446744073709551615 4194304 4228012 140734153947616 140703290778544 140703284257492 0 4 0 16800975 0 0 0 -1 0 0 0 10 0 0
[pid=11143/tid=11145] ppid=11140 vsize=1050640 CPUtime=21.77
/proc/11143/task/11145/stat : 11145 (java) S 11140 11140 1750 0 -1 4202560 65396 0 0 0 2158 19 0 0 20 0 11 0 117457236 1075855360 128083 18446744073709551615 4194304 4228012 140734153947616 140703183416448 140703284258379 0 0 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11146] ppid=11140 vsize=1050640 CPUtime=0
/proc/11143/task/11146/stat : 11146 (java) S 11140 11140 1750 0 -1 4202560 16 0 0 0 0 0 0 0 20 0 11 0 117457237 1075855360 128083 18446744073709551615 4194304 4228012 140734153947616 140703182362640 140703284257492 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11147] ppid=11140 vsize=1050640 CPUtime=0
/proc/11143/task/11147/stat : 11147 (java) S 11140 11140 1750 0 -1 4202560 8 0 0 0 0 0 0 0 20 0 11 0 117457237 1075855360 128083 18446744073709551615 4194304 4228012 140734153947616 140703181309856 140703284257492 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11148] ppid=11140 vsize=1050640 CPUtime=0
/proc/11143/task/11148/stat : 11148 (java) S 11140 11140 1750 0 -1 4202560 0 0 0 0 0 0 0 0 20 0 11 0 117457240 1075855360 128083 18446744073709551615 4194304 4228012 140734153947616 140703180258288 140703284266016 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11149] ppid=11140 vsize=1050640 CPUtime=2.45
/proc/11143/task/11149/stat : 11149 (java) R 11140 11140 1750 0 -1 4202560 11740 0 0 0 241 4 0 0 20 0 11 0 117457240 1075855360 128083 18446744073709551615 4194304 4228012 140734153947616 140703179205392 140703271590927 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11150] ppid=11140 vsize=1050640 CPUtime=2.41
/proc/11143/task/11150/stat : 11150 (java) R 11140 11140 1750 0 -1 4202560 7520 0 0 0 238 3 0 0 20 0 11 0 117457240 1075855360 128083 18446744073709551615 4194304 4228012 140734153947616 140703178152720 140703267207766 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11151] ppid=11140 vsize=1050640 CPUtime=0
/proc/11143/task/11151/stat : 11151 (java) S 11140 11140 1750 0 -1 4202560 0 0 0 0 0 0 0 0 20 0 11 0 117457241 1075855360 128083 18446744073709551615 4194304 4228012 140734153947616 140703177100496 140703284257492 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11152] ppid=11140 vsize=1050640 CPUtime=0.14
/proc/11143/task/11152/stat : 11152 (java) S 11140 11140 1750 0 -1 4202560 24 0 0 0 0 14 0 0 20 0 11 0 117457241 1075855360 128083 18446744073709551615 4194304 4228012 140734153947616 140703176048000 140703284258379 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=11143/tid=11154] ppid=11140 vsize=1050640 CPUtime=0.13
/proc/11143/task/11154/stat : 11154 (java) R 11140 11140 1750 0 -1 4202560 9 0 0 0 7 6 0 0 20 0 11 0 117486557 1075855360 128083 18446744073709551615 4194304 4228012 140734153947616 140703173789008 140703284269357 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
Current children cumulated CPU time (s) 289.5
Current children cumulated vsize (KiB) 1059812

[startup+294.201 s]
/proc/loadavg: 1.01 1.07 1.02 1/71 11154
/proc/meminfo: memFree=86288/1022884 swapFree=0/0
[pid=11140] ppid=11139 vsize=0 CPUtime=289.7
/proc/11140/stat : 11140 (p2cudf-full-1.1) Z 11139 11140 1750 0 -1 4202508 473 134115 0 15 0 0 28909 61 20 0 1 0 117457224 0 0 18446744073709551615 0 0 0 0 0 0 0 16781316 65536 18446744073709551615 0 0 17 0 0 0 0 0 0
/proc/11140/statm: 0 0 0 0 0 0 0
Current children cumulated CPU time (s) 289.7
Current children cumulated vsize (KiB) 0

Child status: 0
Real time (s): 294.201
CPU time (s): 289.706
CPU user time (s): 289.09
CPU system time (s): 0.616038
CPU usage (%): 98.4721
Max. virtual memory (cumulated for all children) (KiB): 1062940

getrusage(RUSAGE_CHILDREN,...) data:
user time used= 289.09
system time used= 0.616038
maximum resident set size= 512404
integral shared memory size= 0
integral unshared data size= 0
integral unshared stack size= 0
page reclaims= 134588
page faults= 15
swaps= 0
block input operations= 26048
block output operations= 744
messages sent= 0
messages received= 0
signals received= 0
voluntary context switches= 7262
involuntary context switches= 41460

runsolver used 0.996062 second user time and 2.16413 second system time

The end