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/dist-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/dist-upgrade/real/f4ebf9e0-360e-11e0-9e6c-00163e3d3b7c.cudf.result -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
Current StackSize limit: 8192 KiB


[startup+0 s]
/proc/loadavg: 1.06 1.07 1.02 2/59 31352
/proc/meminfo: memFree=754428/1022884 swapFree=0/0
[pid=31352] ppid=31351 vsize=1068 CPUtime=0
/proc/31352/stat : 31352 (p2cudf-full-1.1) D 31351 31352 1733 0 -1 4194304 75 0 0 0 0 0 0 0 20 0 1 0 118326181 1093632 1 18446744073709551615 0 0 140734377569150 4291680608 4151632944 0 0 16781316 0 0 0 0 17 0 0 0 0 0 0
/proc/31352/statm: 267 1 0 0 0 28 0

[startup+0.128501 s]
/proc/loadavg: 1.06 1.07 1.02 2/59 31352
/proc/meminfo: memFree=754428/1022884 swapFree=0/0
[pid=31352] ppid=31351 vsize=9172 CPUtime=0
/proc/31352/stat : 31352 (p2cudf-full-1.1) S 31351 31352 1733 0 -1 4202496 454 292 2 1 0 0 0 0 20 0 1 0 118326181 9392128 331 18446744073709551615 4194304 5129932 140734377566112 140734377564256 140110344762462 0 65536 16781316 65538 0 0 0 17 0 0 0 1 0 0
/proc/31352/statm: 2293 331 280 229 0 53 0
Current children cumulated CPU time (s) 0
Current children cumulated vsize (KiB) 9172

[startup+0.200324 s]
/proc/loadavg: 1.06 1.07 1.02 2/59 31352
/proc/meminfo: memFree=754428/1022884 swapFree=0/0
[pid=31352] ppid=31351 vsize=9172 CPUtime=0
/proc/31352/stat : 31352 (p2cudf-full-1.1) S 31351 31352 1733 0 -1 4202496 454 292 2 1 0 0 0 0 20 0 1 0 118326181 9392128 331 18446744073709551615 4194304 5129932 140734377566112 140734377564256 140110344762462 0 65536 16781316 65538 0 0 0 17 0 0 0 1 0 0
/proc/31352/statm: 2293 331 280 229 0 53 0
Current children cumulated CPU time (s) 0
Current children cumulated vsize (KiB) 9172

[startup+0.300295 s]
/proc/loadavg: 1.06 1.07 1.02 2/59 31352
/proc/meminfo: memFree=754428/1022884 swapFree=0/0
[pid=31352] ppid=31351 vsize=9172 CPUtime=0
/proc/31352/stat : 31352 (p2cudf-full-1.1) S 31351 31352 1733 0 -1 4202496 454 292 2 1 0 0 0 0 20 0 1 0 118326181 9392128 331 18446744073709551615 4194304 5129932 140734377566112 140734377564256 140110344762462 0 65536 16781316 65538 0 0 0 17 0 0 0 1 0 0
/proc/31352/statm: 2293 331 280 229 0 53 0
Current children cumulated CPU time (s) 0
Current children cumulated vsize (KiB) 9172

[startup+0.700242 s]
/proc/loadavg: 1.06 1.07 1.02 2/59 31352
/proc/meminfo: memFree=754428/1022884 swapFree=0/0
[pid=31352] ppid=31351 vsize=9172 CPUtime=0
/proc/31352/stat : 31352 (p2cudf-full-1.1) S 31351 31352 1733 0 -1 4202496 454 292 2 1 0 0 0 0 20 0 1 0 118326181 9392128 331 18446744073709551615 4194304 5129932 140734377566112 140734377564256 140110344762462 0 65536 16781316 65538 0 0 0 17 0 0 0 1 0 0
/proc/31352/statm: 2293 331 280 229 0 53 0
Current children cumulated CPU time (s) 0
Current children cumulated vsize (KiB) 9172

[startup+1.50076 s]
/proc/loadavg: 1.06 1.07 1.02 4/70 31364
/proc/meminfo: memFree=719868/1022884 swapFree=0/0
[pid=31352] ppid=31351 vsize=9172 CPUtime=0
/proc/31352/stat : 31352 (p2cudf-full-1.1) S 31351 31352 1733 0 -1 4202496 454 292 2 1 0 0 0 0 20 0 1 0 118326181 9392128 331 18446744073709551615 4194304 5129932 140734377566112 140734377564256 140110344762462 0 65536 16781316 65538 0 0 0 17 0 0 0 1 0 0
/proc/31352/statm: 2293 331 280 229 0 53 0
[pid=31355] ppid=31352 vsize=1033592 CPUtime=1.31
/proc/31355/stat : 31355 (java) S 31352 31352 1733 0 -1 4202496 25108 0 20 0 120 11 0 0 20 0 10 0 118326184 1058398208 22483 18446744073709551615 4194304 4228012 140736090822592 140736090813616 140186839731829 0 0 0 16800975 18446744073709551615 0 0 17 0 0 0 5 0 0
/proc/31355/statm: 258398 22483 2342 9 0 245748 0
[pid=31355/tid=31356] ppid=31352 vsize=1033592 CPUtime=0.62
/proc/31355/task/31356/stat : 31356 (java) R 31352 31352 1733 0 -1 4202560 11307 0 8 0 56 6 0 0 20 0 10 0 118326191 1058398208 22483 18446744073709551615 4194304 4228012 140736090822592 140186846257824 140186744220464 0 4 0 16800975 0 0 0 -1 0 0 0 8 0 0
[pid=31355/tid=31357] ppid=31352 vsize=1033592 CPUtime=0
/proc/31355/task/31357/stat : 31357 (java) S 31352 31352 1733 0 -1 4202560 3 0 0 0 0 0 0 0 20 0 10 0 118326200 1058398208 22483 18446744073709551615 4194304 4228012 140736090822592 140186738904192 140186839746123 0 0 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31358] ppid=31352 vsize=1033592 CPUtime=0
/proc/31355/task/31358/stat : 31358 (java) S 31352 31352 1733 0 -1 4202560 15 0 0 0 0 0 0 0 20 0 10 0 118326200 1058398208 22483 18446744073709551615 4194304 4228012 140736090822592 140186737850384 140186839745236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31359] ppid=31352 vsize=1033592 CPUtime=0
/proc/31355/task/31359/stat : 31359 (java) S 31352 31352 1733 0 -1 4202560 6 0 0 0 0 0 0 0 20 0 10 0 118326200 1058398208 22483 18446744073709551615 4194304 4228012 140736090822592 140186736797600 140186839745236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31360] ppid=31352 vsize=1033592 CPUtime=0
/proc/31355/task/31360/stat : 31360 (java) S 31352 31352 1733 0 -1 4202560 0 0 0 0 0 0 0 0 20 0 10 0 118326204 1058398208 22483 18446744073709551615 4194304 4228012 140736090822592 140186735746032 140186839753760 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31361] ppid=31352 vsize=1033592 CPUtime=0.35
/proc/31355/task/31361/stat : 31361 (java) R 31352 31352 1733 0 -1 4202560 7925 0 0 0 32 3 0 0 20 0 10 0 118326204 1058398208 22483 18446744073709551615 4194304 4228012 140736090822592 140186734678744 140186822839120 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31362] ppid=31352 vsize=1033592 CPUtime=0.32
/proc/31355/task/31362/stat : 31362 (java) R 31352 31352 1733 0 -1 4202560 4598 0 0 0 31 1 0 0 20 0 10 0 118326204 1058398208 22483 18446744073709551615 4194304 4228012 140736090822592 140186733625928 140186825400252 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31363] ppid=31352 vsize=1033592 CPUtime=0
/proc/31355/task/31363/stat : 31363 (java) S 31352 31352 1733 0 -1 4202560 0 0 0 0 0 0 0 0 20 0 10 0 118326204 1058398208 22483 18446744073709551615 4194304 4228012 140736090822592 140186732588240 140186839745236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31364] ppid=31352 vsize=1033592 CPUtime=0
/proc/31355/task/31364/stat : 31364 (java) S 31352 31352 1733 0 -1 4202560 0 0 0 0 0 0 0 0 20 0 10 0 118326204 1058398208 22483 18446744073709551615 4194304 4228012 140736090822592 140186731535744 140186839746123 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
Current children cumulated CPU time (s) 1.31
Current children cumulated vsize (KiB) 1042764

[startup+3.1008 s]
/proc/loadavg: 1.06 1.07 1.02 4/70 31364
/proc/meminfo: memFree=623396/1022884 swapFree=0/0
[pid=31352] ppid=31351 vsize=9172 CPUtime=0
/proc/31352/stat : 31352 (p2cudf-full-1.1) S 31351 31352 1733 0 -1 4202496 454 292 2 1 0 0 0 0 20 0 1 0 118326181 9392128 331 18446744073709551615 4194304 5129932 140734377566112 140734377564256 140110344762462 0 65536 16781316 65538 0 0 0 17 0 0 0 1 0 0
/proc/31352/statm: 2293 331 280 229 0 53 0
[pid=31355] ppid=31352 vsize=1045792 CPUtime=2.9
/proc/31355/stat : 31355 (java) S 31352 31352 1733 0 -1 4202496 75834 0 20 0 255 35 0 0 20 0 10 0 118326184 1070891008 71761 18446744073709551615 4194304 4228012 140736090822592 140736090813616 140186839731829 0 0 0 16800975 18446744073709551615 0 0 17 0 0 0 5 0 0
/proc/31355/statm: 261448 71761 2362 9 0 248798 0
[pid=31355/tid=31356] ppid=31352 vsize=1045792 CPUtime=1.39
/proc/31355/task/31356/stat : 31356 (java) R 31352 31352 1733 0 -1 4202560 47436 0 8 0 115 24 0 0 20 0 10 0 118326191 1070891008 71761 18446744073709551615 4194304 4228012 140736090822592 140186846257856 140186744102408 0 4 0 16800975 0 0 0 -1 0 0 0 8 0 0
[pid=31355/tid=31357] ppid=31352 vsize=1045792 CPUtime=0.18
/proc/31355/task/31357/stat : 31357 (java) S 31352 31352 1733 0 -1 4202560 8739 0 0 0 14 4 0 0 20 0 10 0 118326200 1070891008 71761 18446744073709551615 4194304 4228012 140736090822592 140186738904192 140186839746123 0 0 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31358] ppid=31352 vsize=1045792 CPUtime=0
/proc/31355/task/31358/stat : 31358 (java) S 31352 31352 1733 0 -1 4202560 16 0 0 0 0 0 0 0 20 0 10 0 118326200 1070891008 71761 18446744073709551615 4194304 4228012 140736090822592 140186737850384 140186839745236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31359] ppid=31352 vsize=1045792 CPUtime=0
/proc/31355/task/31359/stat : 31359 (java) S 31352 31352 1733 0 -1 4202560 8 0 0 0 0 0 0 0 20 0 10 0 118326200 1070891008 71761 18446744073709551615 4194304 4228012 140736090822592 140186736797600 140186839745236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31360] ppid=31352 vsize=1045792 CPUtime=0
/proc/31355/task/31360/stat : 31360 (java) S 31352 31352 1733 0 -1 4202560 0 0 0 0 0 0 0 0 20 0 10 0 118326204 1070891008 71761 18446744073709551615 4194304 4228012 140736090822592 140186735746032 140186839753760 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31361] ppid=31352 vsize=1045792 CPUtime=0.65
/proc/31355/task/31361/stat : 31361 (java) S 31352 31352 1733 0 -1 4202560 10866 0 0 0 60 5 0 0 20 0 10 0 118326204 1070891008 71761 18446744073709551615 4194304 4228012 140736090822592 140186734693392 140186839745236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31362] ppid=31352 vsize=1045792 CPUtime=0.65
/proc/31355/task/31362/stat : 31362 (java) S 31352 31352 1733 0 -1 4202560 7515 0 0 0 63 2 0 0 20 0 10 0 118326204 1070891008 71761 18446744073709551615 4194304 4228012 140736090822592 140186733640720 140186839745236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31363] ppid=31352 vsize=1045792 CPUtime=0
/proc/31355/task/31363/stat : 31363 (java) S 31352 31352 1733 0 -1 4202560 0 0 0 0 0 0 0 0 20 0 10 0 118326204 1070891008 71761 18446744073709551615 4194304 4228012 140736090822592 140186732588240 140186839745236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31364] ppid=31352 vsize=1045792 CPUtime=0
/proc/31355/task/31364/stat : 31364 (java) S 31352 31352 1733 0 -1 4202560 0 0 0 0 0 0 0 0 20 0 10 0 118326204 1070891008 71761 18446744073709551615 4194304 4228012 140736090822592 140186731535744 140186839746123 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
Current children cumulated CPU time (s) 2.9
Current children cumulated vsize (KiB) 1054964

[startup+6.30079 s]
/proc/loadavg: 1.06 1.07 1.01 3/70 31364
/proc/meminfo: memFree=375272/1022884 swapFree=0/0
[pid=31352] ppid=31351 vsize=9172 CPUtime=0
/proc/31352/stat : 31352 (p2cudf-full-1.1) S 31351 31352 1733 0 -1 4202496 454 292 2 1 0 0 0 0 20 0 1 0 118326181 9392128 331 18446744073709551615 4194304 5129932 140734377566112 140734377564256 140110344762462 0 65536 16781316 65538 0 0 0 17 0 0 0 1 0 0
/proc/31352/statm: 2293 331 280 229 0 53 0
[pid=31355] ppid=31352 vsize=1039704 CPUtime=6.04
/proc/31355/stat : 31355 (java) S 31352 31352 1733 0 -1 4202496 99221 0 20 0 560 44 0 0 20 0 10 0 118326184 1064656896 93607 18446744073709551615 4194304 4228012 140736090822592 140736090813616 140186839731829 0 0 0 16800975 18446744073709551615 0 0 17 0 0 0 5 0 0
/proc/31355/statm: 259926 93607 2373 9 0 247276 0
[pid=31355/tid=31356] ppid=31352 vsize=1039704 CPUtime=2.87
/proc/31355/task/31356/stat : 31356 (java) R 31352 31352 1733 0 -1 4202560 47736 0 8 0 261 26 0 0 20 0 10 0 118326191 1064656896 93607 18446744073709551615 4194304 4228012 140736090822592 140186846265816 140186744621839 0 4 0 16800975 0 0 0 -1 0 0 0 10 0 0
[pid=31355/tid=31357] ppid=31352 vsize=1039704 CPUtime=0.7
/proc/31355/task/31357/stat : 31357 (java) S 31352 31352 1733 0 -1 4202560 31549 0 0 0 60 10 0 0 20 0 10 0 118326200 1064656896 93607 18446744073709551615 4194304 4228012 140736090822592 140186738904192 140186839746123 0 0 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31358] ppid=31352 vsize=1039704 CPUtime=0
/proc/31355/task/31358/stat : 31358 (java) S 31352 31352 1733 0 -1 4202560 16 0 0 0 0 0 0 0 20 0 10 0 118326200 1064656896 93607 18446744073709551615 4194304 4228012 140736090822592 140186737850384 140186839745236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31359] ppid=31352 vsize=1039704 CPUtime=0
/proc/31355/task/31359/stat : 31359 (java) S 31352 31352 1733 0 -1 4202560 8 0 0 0 0 0 0 0 20 0 10 0 118326200 1064656896 93607 18446744073709551615 4194304 4228012 140736090822592 140186736797600 140186839745236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31360] ppid=31352 vsize=1039704 CPUtime=0
/proc/31355/task/31360/stat : 31360 (java) S 31352 31352 1733 0 -1 4202560 0 0 0 0 0 0 0 0 20 0 10 0 118326204 1064656896 93607 18446744073709551615 4194304 4228012 140736090822592 140186735746032 140186839753760 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31361] ppid=31352 vsize=1039704 CPUtime=1.27
/proc/31355/task/31361/stat : 31361 (java) R 31352 31352 1733 0 -1 4202560 11102 0 0 0 122 5 0 0 20 0 10 0 118326204 1064656896 93607 18446744073709551615 4194304 4228012 140736090822592 140186734693136 140186824036309 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31362] ppid=31352 vsize=1039704 CPUtime=1.16
/proc/31355/task/31362/stat : 31362 (java) R 31352 31352 1733 0 -1 4202560 7556 0 0 0 114 2 0 0 20 0 10 0 118326204 1064656896 93607 18446744073709551615 4194304 4228012 140736090822592 140186733640464 140186823562685 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31363] ppid=31352 vsize=1039704 CPUtime=0
/proc/31355/task/31363/stat : 31363 (java) S 31352 31352 1733 0 -1 4202560 0 0 0 0 0 0 0 0 20 0 10 0 118326204 1064656896 93607 18446744073709551615 4194304 4228012 140736090822592 140186732588240 140186839745236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31364] ppid=31352 vsize=1039704 CPUtime=0
/proc/31355/task/31364/stat : 31364 (java) S 31352 31352 1733 0 -1 4202560 0 0 0 0 0 0 0 0 20 0 10 0 118326204 1064656896 93607 18446744073709551615 4194304 4228012 140736090822592 140186731535744 140186839746123 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
Current children cumulated CPU time (s) 6.04
Current children cumulated vsize (KiB) 1048876

[startup+12.7009 s]
/proc/loadavg: 1.21 1.10 1.02 2/71 31365
/proc/meminfo: memFree=330872/1022884 swapFree=0/0
[pid=31352] ppid=31351 vsize=9172 CPUtime=0
/proc/31352/stat : 31352 (p2cudf-full-1.1) S 31351 31352 1733 0 -1 4202496 454 292 2 1 0 0 0 0 20 0 1 0 118326181 9392128 331 18446744073709551615 4194304 5129932 140734377566112 140734377564256 140110344762462 0 65536 16781316 65538 0 0 0 17 0 0 0 1 0 0
/proc/31352/statm: 2293 331 280 229 0 53 0
[pid=31355] ppid=31352 vsize=1040732 CPUtime=12.34
/proc/31355/stat : 31355 (java) S 31352 31352 1733 0 -1 4202496 110093 0 20 0 1187 47 0 0 20 0 11 0 118326184 1065709568 104479 18446744073709551615 4194304 4228012 140736090822592 140736090813616 140186839731829 0 0 0 16800975 18446744073709551615 0 0 17 0 0 0 5 0 0
/proc/31355/statm: 260183 104479 2393 9 0 247533 0
[pid=31355/tid=31356] ppid=31352 vsize=1040732 CPUtime=6.34
/proc/31355/task/31356/stat : 31356 (java) R 31352 31352 1733 0 -1 4202560 47826 0 8 0 608 26 0 0 20 0 11 0 118326191 1065709568 104479 18446744073709551615 4194304 4228012 140736090822592 140186846265336 140186745021948 0 4 0 16800975 0 0 0 -1 0 0 0 10 0 0
[pid=31355/tid=31357] ppid=31352 vsize=1040732 CPUtime=1.38
/proc/31355/task/31357/stat : 31357 (java) S 31352 31352 1733 0 -1 4202560 42169 0 0 0 124 14 0 0 20 0 11 0 118326200 1065709568 104479 18446744073709551615 4194304 4228012 140736090822592 140186738904192 140186839746123 0 0 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31358] ppid=31352 vsize=1040732 CPUtime=0
/proc/31355/task/31358/stat : 31358 (java) S 31352 31352 1733 0 -1 4202560 16 0 0 0 0 0 0 0 20 0 11 0 118326200 1065709568 104479 18446744073709551615 4194304 4228012 140736090822592 140186737850384 140186839745236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31359] ppid=31352 vsize=1040732 CPUtime=0
/proc/31355/task/31359/stat : 31359 (java) S 31352 31352 1733 0 -1 4202560 8 0 0 0 0 0 0 0 20 0 11 0 118326200 1065709568 104479 18446744073709551615 4194304 4228012 140736090822592 140186736797600 140186839745236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31360] ppid=31352 vsize=1040732 CPUtime=0
/proc/31355/task/31360/stat : 31360 (java) S 31352 31352 1733 0 -1 4202560 0 0 0 0 0 0 0 0 20 0 11 0 118326204 1065709568 104479 18446744073709551615 4194304 4228012 140736090822592 140186735746032 140186839753760 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31361] ppid=31352 vsize=1040732 CPUtime=2.2
/proc/31355/task/31361/stat : 31361 (java) S 31352 31352 1733 0 -1 4202560 11166 0 0 0 215 5 0 0 20 0 11 0 118326204 1065709568 104479 18446744073709551615 4194304 4228012 140736090822592 140186734693392 140186839745236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31362] ppid=31352 vsize=1040732 CPUtime=2.38
/proc/31355/task/31362/stat : 31362 (java) S 31352 31352 1733 0 -1 4202560 7648 0 0 0 236 2 0 0 20 0 11 0 118326204 1065709568 104479 18446744073709551615 4194304 4228012 140736090822592 140186733640720 140186839745236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31363] ppid=31352 vsize=1040732 CPUtime=0
/proc/31355/task/31363/stat : 31363 (java) S 31352 31352 1733 0 -1 4202560 0 0 0 0 0 0 0 0 20 0 11 0 118326204 1065709568 104479 18446744073709551615 4194304 4228012 140736090822592 140186732588240 140186839745236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31364] ppid=31352 vsize=1040732 CPUtime=0
/proc/31355/task/31364/stat : 31364 (java) S 31352 31352 1733 0 -1 4202560 0 0 0 0 0 0 0 0 20 0 11 0 118326204 1065709568 104479 18446744073709551615 4194304 4228012 140736090822592 140186731535744 140186839746123 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31365] ppid=31352 vsize=1040732 CPUtime=0
/proc/31355/task/31365/stat : 31365 (java) S 31352 31352 1733 0 -1 4202560 6 0 0 0 0 0 0 0 20 0 11 0 118326966 1065709568 104479 18446744073709551615 4194304 4228012 140736090822592 140186730329952 140186839746123 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
Current children cumulated CPU time (s) 12.34
Current children cumulated vsize (KiB) 1049904

[startup+25.5008 s]
/proc/loadavg: 1.16 1.10 1.02 2/71 31365
/proc/meminfo: memFree=318472/1022884 swapFree=0/0
[pid=31352] ppid=31351 vsize=9172 CPUtime=0
/proc/31352/stat : 31352 (p2cudf-full-1.1) S 31351 31352 1733 0 -1 4202496 454 292 2 1 0 0 0 0 20 0 1 0 118326181 9392128 331 18446744073709551615 4194304 5129932 140734377566112 140734377564256 140110344762462 0 65536 16781316 65538 0 0 0 17 0 0 0 1 0 0
/proc/31352/statm: 2293 331 280 229 0 53 0
[pid=31355] ppid=31352 vsize=1038880 CPUtime=24.96
/proc/31355/stat : 31355 (java) S 31352 31352 1733 0 -1 4202496 113886 0 20 0 2447 49 0 0 20 0 11 0 118326184 1063813120 107542 18446744073709551615 4194304 4228012 140736090822592 140736090813616 140186839731829 0 0 0 16800975 18446744073709551615 0 0 17 0 0 0 5 0 0
/proc/31355/statm: 259720 107542 2393 9 0 247070 0
[pid=31355/tid=31356] ppid=31352 vsize=1038880 CPUtime=16.08
/proc/31355/task/31356/stat : 31356 (java) R 31352 31352 1733 0 -1 4202560 47826 0 8 0 1582 26 0 0 20 0 11 0 118326191 1063813120 107542 18446744073709551615 4194304 4228012 140736090822592 140186846265304 140186744921490 0 4 0 16800975 0 0 0 -1 0 0 0 10 0 0
[pid=31355/tid=31357] ppid=31352 vsize=1038880 CPUtime=4.16
/proc/31355/task/31357/stat : 31357 (java) S 31352 31352 1733 0 -1 4202560 45962 0 0 0 401 15 0 0 20 0 11 0 118326200 1063813120 107542 18446744073709551615 4194304 4228012 140736090822592 140186738904192 140186839746123 0 0 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31358] ppid=31352 vsize=1038880 CPUtime=0
/proc/31355/task/31358/stat : 31358 (java) S 31352 31352 1733 0 -1 4202560 16 0 0 0 0 0 0 0 20 0 11 0 118326200 1063813120 107542 18446744073709551615 4194304 4228012 140736090822592 140186737850384 140186839745236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31359] ppid=31352 vsize=1038880 CPUtime=0
/proc/31355/task/31359/stat : 31359 (java) S 31352 31352 1733 0 -1 4202560 8 0 0 0 0 0 0 0 20 0 11 0 118326200 1063813120 107542 18446744073709551615 4194304 4228012 140736090822592 140186736797600 140186839745236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31360] ppid=31352 vsize=1038880 CPUtime=0
/proc/31355/task/31360/stat : 31360 (java) S 31352 31352 1733 0 -1 4202560 0 0 0 0 0 0 0 0 20 0 11 0 118326204 1063813120 107542 18446744073709551615 4194304 4228012 140736090822592 140186735746032 140186839753760 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31361] ppid=31352 vsize=1038880 CPUtime=2.26
/proc/31355/task/31361/stat : 31361 (java) S 31352 31352 1733 0 -1 4202560 11166 0 0 0 221 5 0 0 20 0 11 0 118326204 1063813120 107542 18446744073709551615 4194304 4228012 140736090822592 140186734693392 140186839745236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31362] ppid=31352 vsize=1038880 CPUtime=2.41
/proc/31355/task/31362/stat : 31362 (java) S 31352 31352 1733 0 -1 4202560 7648 0 0 0 239 2 0 0 20 0 11 0 118326204 1063813120 107542 18446744073709551615 4194304 4228012 140736090822592 140186733640720 140186839745236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31363] ppid=31352 vsize=1038880 CPUtime=0
/proc/31355/task/31363/stat : 31363 (java) S 31352 31352 1733 0 -1 4202560 0 0 0 0 0 0 0 0 20 0 11 0 118326204 1063813120 107542 18446744073709551615 4194304 4228012 140736090822592 140186732588240 140186839745236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31364] ppid=31352 vsize=1038880 CPUtime=0.01
/proc/31355/task/31364/stat : 31364 (java) S 31352 31352 1733 0 -1 4202560 0 0 0 0 1 0 0 0 20 0 11 0 118326204 1063813120 107542 18446744073709551615 4194304 4228012 140736090822592 140186731535744 140186839746123 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31365] ppid=31352 vsize=1038880 CPUtime=0
/proc/31355/task/31365/stat : 31365 (java) S 31352 31352 1733 0 -1 4202560 6 0 0 0 0 0 0 0 20 0 11 0 118326966 1063813120 107542 18446744073709551615 4194304 4228012 140736090822592 140186730329952 140186839746123 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
Current children cumulated CPU time (s) 24.96
Current children cumulated vsize (KiB) 1048052

[startup+51.1008 s]
/proc/loadavg: 1.11 1.09 1.02 2/71 31368
/proc/meminfo: memFree=300988/1022884 swapFree=0/0
[pid=31352] ppid=31351 vsize=9172 CPUtime=0
/proc/31352/stat : 31352 (p2cudf-full-1.1) S 31351 31352 1733 0 -1 4202496 454 292 2 1 0 0 0 0 20 0 1 0 118326181 9392128 331 18446744073709551615 4194304 5129932 140734377566112 140734377564256 140110344762462 0 65536 16781316 65538 0 0 0 17 0 0 0 1 0 0
/proc/31352/statm: 2293 331 280 229 0 53 0
[pid=31355] ppid=31352 vsize=1038880 CPUtime=50.19
/proc/31355/stat : 31355 (java) S 31352 31352 1733 0 -1 4202496 118107 0 20 0 4969 50 0 0 20 0 11 0 118326184 1063813120 111759 18446744073709551615 4194304 4228012 140736090822592 140736090813616 140186839731829 0 0 0 16800975 18446744073709551615 0 0 17 0 0 0 5 0 0
/proc/31355/statm: 259720 111759 2393 9 0 247070 0
[pid=31355/tid=31356] ppid=31352 vsize=1038880 CPUtime=38.07
/proc/31355/task/31356/stat : 31356 (java) R 31352 31352 1733 0 -1 4202560 47826 0 8 0 3781 26 0 0 20 0 11 0 118326191 1063813120 111759 18446744073709551615 4194304 4228012 140736090822592 140186846265304 140186744937920 0 4 0 16800975 0 0 0 -1 0 0 0 10 0 0
[pid=31355/tid=31357] ppid=31352 vsize=1038880 CPUtime=7.4
/proc/31355/task/31357/stat : 31357 (java) S 31352 31352 1733 0 -1 4202560 50182 0 0 0 724 16 0 0 20 0 11 0 118326200 1063813120 111759 18446744073709551615 4194304 4228012 140736090822592 140186738904192 140186839746123 0 0 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31358] ppid=31352 vsize=1038880 CPUtime=0
/proc/31355/task/31358/stat : 31358 (java) S 31352 31352 1733 0 -1 4202560 16 0 0 0 0 0 0 0 20 0 11 0 118326200 1063813120 111759 18446744073709551615 4194304 4228012 140736090822592 140186737850384 140186839745236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31359] ppid=31352 vsize=1038880 CPUtime=0
/proc/31355/task/31359/stat : 31359 (java) S 31352 31352 1733 0 -1 4202560 8 0 0 0 0 0 0 0 20 0 11 0 118326200 1063813120 111759 18446744073709551615 4194304 4228012 140736090822592 140186736797600 140186839745236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31360] ppid=31352 vsize=1038880 CPUtime=0
/proc/31355/task/31360/stat : 31360 (java) S 31352 31352 1733 0 -1 4202560 0 0 0 0 0 0 0 0 20 0 11 0 118326204 1063813120 111759 18446744073709551615 4194304 4228012 140736090822592 140186735746032 140186839753760 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31361] ppid=31352 vsize=1038880 CPUtime=2.26
/proc/31355/task/31361/stat : 31361 (java) S 31352 31352 1733 0 -1 4202560 11166 0 0 0 221 5 0 0 20 0 11 0 118326204 1063813120 111759 18446744073709551615 4194304 4228012 140736090822592 140186734693392 140186839745236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31362] ppid=31352 vsize=1038880 CPUtime=2.41
/proc/31355/task/31362/stat : 31362 (java) S 31352 31352 1733 0 -1 4202560 7648 0 0 0 239 2 0 0 20 0 11 0 118326204 1063813120 111759 18446744073709551615 4194304 4228012 140736090822592 140186733640720 140186839745236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31363] ppid=31352 vsize=1038880 CPUtime=0
/proc/31355/task/31363/stat : 31363 (java) S 31352 31352 1733 0 -1 4202560 0 0 0 0 0 0 0 0 20 0 11 0 118326204 1063813120 111759 18446744073709551615 4194304 4228012 140736090822592 140186732588240 140186839745236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31364] ppid=31352 vsize=1038880 CPUtime=0.02
/proc/31355/task/31364/stat : 31364 (java) S 31352 31352 1733 0 -1 4202560 1 0 0 0 2 0 0 0 20 0 11 0 118326204 1063813120 111759 18446744073709551615 4194304 4228012 140736090822592 140186731535744 140186839746123 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31365] ppid=31352 vsize=1038880 CPUtime=0
/proc/31355/task/31365/stat : 31365 (java) S 31352 31352 1733 0 -1 4202560 6 0 0 0 0 0 0 0 20 0 11 0 118326966 1063813120 111759 18446744073709551615 4194304 4228012 140736090822592 140186730329952 140186839746123 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
Current children cumulated CPU time (s) 50.19
Current children cumulated vsize (KiB) 1048052

[startup+102.301 s]
/proc/loadavg: 1.10 1.09 1.02 2/71 31368
/proc/meminfo: memFree=282884/1022884 swapFree=0/0
[pid=31352] ppid=31351 vsize=9172 CPUtime=0
/proc/31352/stat : 31352 (p2cudf-full-1.1) S 31351 31352 1733 0 -1 4202496 454 292 2 1 0 0 0 0 20 0 1 0 118326181 9392128 331 18446744073709551615 4194304 5129932 140734377566112 140734377564256 140110344762462 0 65536 16781316 65538 0 0 0 17 0 0 0 1 0 0
/proc/31352/statm: 2293 331 280 229 0 53 0
[pid=31355] ppid=31352 vsize=1038880 CPUtime=100.68
/proc/31355/stat : 31355 (java) S 31352 31352 1733 0 -1 4202496 122579 0 20 0 10017 51 0 0 20 0 11 0 118326184 1063813120 116227 18446744073709551615 4194304 4228012 140736090822592 140736090813616 140186839731829 0 0 0 16800975 18446744073709551615 0 0 17 0 0 0 5 0 0
/proc/31355/statm: 259720 116227 2393 9 0 247070 0
[pid=31355/tid=31356] ppid=31352 vsize=1038880 CPUtime=83.56
/proc/31355/task/31356/stat : 31356 (java) R 31352 31352 1733 0 -1 4202560 47826 0 8 0 8330 26 0 0 20 0 11 0 118326191 1063813120 116227 18446744073709551615 4194304 4228012 140736090822592 140186846265304 140186743923847 0 4 0 16800975 0 0 0 -1 0 0 0 11 0 0
[pid=31355/tid=31357] ppid=31352 vsize=1038880 CPUtime=12.37
/proc/31355/task/31357/stat : 31357 (java) S 31352 31352 1733 0 -1 4202560 54651 0 0 0 1219 18 0 0 20 0 11 0 118326200 1063813120 116227 18446744073709551615 4194304 4228012 140736090822592 140186738904192 140186839746123 0 0 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31358] ppid=31352 vsize=1038880 CPUtime=0
/proc/31355/task/31358/stat : 31358 (java) S 31352 31352 1733 0 -1 4202560 16 0 0 0 0 0 0 0 20 0 11 0 118326200 1063813120 116227 18446744073709551615 4194304 4228012 140736090822592 140186737850384 140186839745236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31359] ppid=31352 vsize=1038880 CPUtime=0
/proc/31355/task/31359/stat : 31359 (java) S 31352 31352 1733 0 -1 4202560 8 0 0 0 0 0 0 0 20 0 11 0 118326200 1063813120 116227 18446744073709551615 4194304 4228012 140736090822592 140186736797600 140186839745236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31360] ppid=31352 vsize=1038880 CPUtime=0
/proc/31355/task/31360/stat : 31360 (java) S 31352 31352 1733 0 -1 4202560 0 0 0 0 0 0 0 0 20 0 11 0 118326204 1063813120 116227 18446744073709551615 4194304 4228012 140736090822592 140186735746032 140186839753760 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31361] ppid=31352 vsize=1038880 CPUtime=2.26
/proc/31355/task/31361/stat : 31361 (java) S 31352 31352 1733 0 -1 4202560 11166 0 0 0 221 5 0 0 20 0 11 0 118326204 1063813120 116227 18446744073709551615 4194304 4228012 140736090822592 140186734693392 140186839745236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31362] ppid=31352 vsize=1038880 CPUtime=2.41
/proc/31355/task/31362/stat : 31362 (java) S 31352 31352 1733 0 -1 4202560 7648 0 0 0 239 2 0 0 20 0 11 0 118326204 1063813120 116227 18446744073709551615 4194304 4228012 140736090822592 140186733640720 140186839745236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31363] ppid=31352 vsize=1038880 CPUtime=0
/proc/31355/task/31363/stat : 31363 (java) S 31352 31352 1733 0 -1 4202560 0 0 0 0 0 0 0 0 20 0 11 0 118326204 1063813120 116227 18446744073709551615 4194304 4228012 140736090822592 140186732588240 140186839745236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31364] ppid=31352 vsize=1038880 CPUtime=0.05
/proc/31355/task/31364/stat : 31364 (java) S 31352 31352 1733 0 -1 4202560 4 0 0 0 5 0 0 0 20 0 11 0 118326204 1063813120 116227 18446744073709551615 4194304 4228012 140736090822592 140186731535744 140186839746123 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31365] ppid=31352 vsize=1038880 CPUtime=0
/proc/31355/task/31365/stat : 31365 (java) S 31352 31352 1733 0 -1 4202560 6 0 0 0 0 0 0 0 20 0 11 0 118326966 1063813120 116227 18446744073709551615 4194304 4228012 140736090822592 140186730329952 140186839746123 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
Current children cumulated CPU time (s) 100.68
Current children cumulated vsize (KiB) 1048052

[startup+162.301 s]
/proc/loadavg: 1.04 1.07 1.02 2/71 31368
/proc/meminfo: memFree=270732/1022884 swapFree=0/0
[pid=31352] ppid=31351 vsize=9172 CPUtime=0
/proc/31352/stat : 31352 (p2cudf-full-1.1) S 31351 31352 1733 0 -1 4202496 454 292 2 1 0 0 0 0 20 0 1 0 118326181 9392128 331 18446744073709551615 4194304 5129932 140734377566112 140734377564256 140110344762462 0 65536 16781316 65538 0 0 0 17 0 0 0 1 0 0
/proc/31352/statm: 2293 331 280 229 0 53 0
[pid=31355] ppid=31352 vsize=1038880 CPUtime=159.88
/proc/31355/stat : 31355 (java) S 31352 31352 1733 0 -1 4202496 125598 0 20 0 15937 51 0 0 20 0 11 0 118326184 1063813120 119238 18446744073709551615 4194304 4228012 140736090822592 140736090813616 140186839731829 0 0 0 16800975 18446744073709551615 0 0 17 0 0 0 5 0 0
/proc/31355/statm: 259720 119238 2393 9 0 247070 0
[pid=31355/tid=31356] ppid=31352 vsize=1038880 CPUtime=138.84
/proc/31355/task/31356/stat : 31356 (java) R 31352 31352 1733 0 -1 4202560 47826 0 8 0 13858 26 0 0 20 0 11 0 118326191 1063813120 119238 18446744073709551615 4194304 4228012 140736090822592 140186846265304 140186745059304 0 4 0 16800975 0 0 0 -1 0 0 0 12 0 0
[pid=31355/tid=31357] ppid=31352 vsize=1038880 CPUtime=16.24
/proc/31355/task/31357/stat : 31357 (java) S 31352 31352 1733 0 -1 4202560 57664 0 0 0 1606 18 0 0 20 0 11 0 118326200 1063813120 119238 18446744073709551615 4194304 4228012 140736090822592 140186738904192 140186839746123 0 0 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31358] ppid=31352 vsize=1038880 CPUtime=0
/proc/31355/task/31358/stat : 31358 (java) S 31352 31352 1733 0 -1 4202560 16 0 0 0 0 0 0 0 20 0 11 0 118326200 1063813120 119238 18446744073709551615 4194304 4228012 140736090822592 140186737850384 140186839745236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31359] ppid=31352 vsize=1038880 CPUtime=0
/proc/31355/task/31359/stat : 31359 (java) S 31352 31352 1733 0 -1 4202560 8 0 0 0 0 0 0 0 20 0 11 0 118326200 1063813120 119238 18446744073709551615 4194304 4228012 140736090822592 140186736797600 140186839745236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31360] ppid=31352 vsize=1038880 CPUtime=0
/proc/31355/task/31360/stat : 31360 (java) S 31352 31352 1733 0 -1 4202560 0 0 0 0 0 0 0 0 20 0 11 0 118326204 1063813120 119238 18446744073709551615 4194304 4228012 140736090822592 140186735746032 140186839753760 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31361] ppid=31352 vsize=1038880 CPUtime=2.29
/proc/31355/task/31361/stat : 31361 (java) S 31352 31352 1733 0 -1 4202560 11166 0 0 0 224 5 0 0 20 0 11 0 118326204 1063813120 119238 18446744073709551615 4194304 4228012 140736090822592 140186734693392 140186839745236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31362] ppid=31352 vsize=1038880 CPUtime=2.41
/proc/31355/task/31362/stat : 31362 (java) S 31352 31352 1733 0 -1 4202560 7648 0 0 0 239 2 0 0 20 0 11 0 118326204 1063813120 119238 18446744073709551615 4194304 4228012 140736090822592 140186733640720 140186839745236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31363] ppid=31352 vsize=1038880 CPUtime=0
/proc/31355/task/31363/stat : 31363 (java) S 31352 31352 1733 0 -1 4202560 0 0 0 0 0 0 0 0 20 0 11 0 118326204 1063813120 119238 18446744073709551615 4194304 4228012 140736090822592 140186732588240 140186839745236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31364] ppid=31352 vsize=1038880 CPUtime=0.08
/proc/31355/task/31364/stat : 31364 (java) S 31352 31352 1733 0 -1 4202560 10 0 0 0 8 0 0 0 20 0 11 0 118326204 1063813120 119238 18446744073709551615 4194304 4228012 140736090822592 140186731535744 140186839746123 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31365] ppid=31352 vsize=1038880 CPUtime=0
/proc/31355/task/31365/stat : 31365 (java) S 31352 31352 1733 0 -1 4202560 6 0 0 0 0 0 0 0 20 0 11 0 118326966 1063813120 119238 18446744073709551615 4194304 4228012 140736090822592 140186730329952 140186839746123 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
Current children cumulated CPU time (s) 159.88
Current children cumulated vsize (KiB) 1048052

[startup+222.304 s]
/proc/loadavg: 1.07 1.07 1.02 2/71 31368
/proc/meminfo: memFree=253992/1022884 swapFree=0/0
[pid=31352] ppid=31351 vsize=9172 CPUtime=0
/proc/31352/stat : 31352 (p2cudf-full-1.1) S 31351 31352 1733 0 -1 4202496 454 292 2 1 0 0 0 0 20 0 1 0 118326181 9392128 331 18446744073709551615 4194304 5129932 140734377566112 140734377564256 140110344762462 0 65536 16781316 65538 0 0 0 17 0 0 0 1 0 0
/proc/31352/statm: 2293 331 280 229 0 53 0
[pid=31355] ppid=31352 vsize=1038880 CPUtime=219.08
/proc/31355/stat : 31355 (java) S 31352 31352 1733 0 -1 4202496 129779 0 20 0 21855 53 0 0 20 0 11 0 118326184 1063813120 123411 18446744073709551615 4194304 4228012 140736090822592 140736090813616 140186839731829 0 0 0 16800975 18446744073709551615 0 0 17 0 0 0 5 0 0
/proc/31355/statm: 259720 123411 2393 9 0 247070 0
[pid=31355/tid=31356] ppid=31352 vsize=1038880 CPUtime=194.84
/proc/31355/task/31356/stat : 31356 (java) R 31352 31352 1733 0 -1 4202560 47826 0 8 0 19458 26 0 0 20 0 11 0 118326191 1063813120 123411 18446744073709551615 4194304 4228012 140736090822592 140186846265304 140186745049084 0 4 0 16800975 0 0 0 -1 0 0 0 12 0 0
[pid=31355/tid=31357] ppid=31352 vsize=1038880 CPUtime=19.4
/proc/31355/task/31357/stat : 31357 (java) S 31352 31352 1733 0 -1 4202560 61839 0 0 0 1920 20 0 0 20 0 11 0 118326200 1063813120 123411 18446744073709551615 4194304 4228012 140736090822592 140186738904192 140186839746123 0 0 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31358] ppid=31352 vsize=1038880 CPUtime=0
/proc/31355/task/31358/stat : 31358 (java) S 31352 31352 1733 0 -1 4202560 16 0 0 0 0 0 0 0 20 0 11 0 118326200 1063813120 123411 18446744073709551615 4194304 4228012 140736090822592 140186737850384 140186839745236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31359] ppid=31352 vsize=1038880 CPUtime=0
/proc/31355/task/31359/stat : 31359 (java) S 31352 31352 1733 0 -1 4202560 8 0 0 0 0 0 0 0 20 0 11 0 118326200 1063813120 123411 18446744073709551615 4194304 4228012 140736090822592 140186736797600 140186839745236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31360] ppid=31352 vsize=1038880 CPUtime=0
/proc/31355/task/31360/stat : 31360 (java) S 31352 31352 1733 0 -1 4202560 0 0 0 0 0 0 0 0 20 0 11 0 118326204 1063813120 123411 18446744073709551615 4194304 4228012 140736090822592 140186735746032 140186839753760 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31361] ppid=31352 vsize=1038880 CPUtime=2.29
/proc/31355/task/31361/stat : 31361 (java) S 31352 31352 1733 0 -1 4202560 11166 0 0 0 224 5 0 0 20 0 11 0 118326204 1063813120 123411 18446744073709551615 4194304 4228012 140736090822592 140186734693392 140186839745236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31362] ppid=31352 vsize=1038880 CPUtime=2.41
/proc/31355/task/31362/stat : 31362 (java) S 31352 31352 1733 0 -1 4202560 7648 0 0 0 239 2 0 0 20 0 11 0 118326204 1063813120 123411 18446744073709551615 4194304 4228012 140736090822592 140186733640720 140186839745236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31363] ppid=31352 vsize=1038880 CPUtime=0
/proc/31355/task/31363/stat : 31363 (java) S 31352 31352 1733 0 -1 4202560 0 0 0 0 0 0 0 0 20 0 11 0 118326204 1063813120 123411 18446744073709551615 4194304 4228012 140736090822592 140186732588240 140186839745236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31364] ppid=31352 vsize=1038880 CPUtime=0.11
/proc/31355/task/31364/stat : 31364 (java) S 31352 31352 1733 0 -1 4202560 16 0 0 0 11 0 0 0 20 0 11 0 118326204 1063813120 123411 18446744073709551615 4194304 4228012 140736090822592 140186731535744 140186839746123 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31365] ppid=31352 vsize=1038880 CPUtime=0
/proc/31355/task/31365/stat : 31365 (java) S 31352 31352 1733 0 -1 4202560 6 0 0 0 0 0 0 0 20 0 11 0 118326966 1063813120 123411 18446744073709551615 4194304 4228012 140736090822592 140186730329952 140186839746123 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
Current children cumulated CPU time (s) 219.08
Current children cumulated vsize (KiB) 1048052

[startup+282.301 s]
/proc/loadavg: 1.08 1.07 1.01 2/71 31368
/proc/meminfo: memFree=237624/1022884 swapFree=0/0
[pid=31352] ppid=31351 vsize=9172 CPUtime=0
/proc/31352/stat : 31352 (p2cudf-full-1.1) S 31351 31352 1733 0 -1 4202496 454 292 2 1 0 0 0 0 20 0 1 0 118326181 9392128 331 18446744073709551615 4194304 5129932 140734377566112 140734377564256 140110344762462 0 65536 16781316 65538 0 0 0 17 0 0 0 1 0 0
/proc/31352/statm: 2293 331 280 229 0 53 0
[pid=31355] ppid=31352 vsize=1038880 CPUtime=278.47
/proc/31355/stat : 31355 (java) S 31352 31352 1733 0 -1 4202496 133856 0 20 0 27793 54 0 0 20 0 11 0 118326184 1063813120 127480 18446744073709551615 4194304 4228012 140736090822592 140736090813616 140186839731829 0 0 0 16800975 18446744073709551615 0 0 17 0 0 0 5 0 0
/proc/31355/statm: 259720 127480 2393 9 0 247070 0
[pid=31355/tid=31356] ppid=31352 vsize=1038880 CPUtime=251.18
/proc/31355/task/31356/stat : 31356 (java) R 31352 31352 1733 0 -1 4202560 47826 0 8 0 25092 26 0 0 20 0 11 0 118326191 1063813120 127480 18446744073709551615 4194304 4228012 140736090822592 140186846265304 140186744528566 0 4 0 16800975 0 0 0 -1 0 0 0 12 0 0
[pid=31355/tid=31357] ppid=31352 vsize=1038880 CPUtime=22.38
/proc/31355/task/31357/stat : 31357 (java) S 31352 31352 1733 0 -1 4202560 65910 0 0 0 2218 20 0 0 20 0 11 0 118326200 1063813120 127480 18446744073709551615 4194304 4228012 140736090822592 140186738904192 140186839746123 0 0 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31358] ppid=31352 vsize=1038880 CPUtime=0
/proc/31355/task/31358/stat : 31358 (java) S 31352 31352 1733 0 -1 4202560 16 0 0 0 0 0 0 0 20 0 11 0 118326200 1063813120 127480 18446744073709551615 4194304 4228012 140736090822592 140186737850384 140186839745236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31359] ppid=31352 vsize=1038880 CPUtime=0
/proc/31355/task/31359/stat : 31359 (java) S 31352 31352 1733 0 -1 4202560 8 0 0 0 0 0 0 0 20 0 11 0 118326200 1063813120 127480 18446744073709551615 4194304 4228012 140736090822592 140186736797600 140186839745236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31360] ppid=31352 vsize=1038880 CPUtime=0
/proc/31355/task/31360/stat : 31360 (java) S 31352 31352 1733 0 -1 4202560 0 0 0 0 0 0 0 0 20 0 11 0 118326204 1063813120 127480 18446744073709551615 4194304 4228012 140736090822592 140186735746032 140186839753760 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31361] ppid=31352 vsize=1038880 CPUtime=2.31
/proc/31355/task/31361/stat : 31361 (java) S 31352 31352 1733 0 -1 4202560 11166 0 0 0 226 5 0 0 20 0 11 0 118326204 1063813120 127480 18446744073709551615 4194304 4228012 140736090822592 140186734693392 140186839745236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31362] ppid=31352 vsize=1038880 CPUtime=2.42
/proc/31355/task/31362/stat : 31362 (java) S 31352 31352 1733 0 -1 4202560 7648 0 0 0 240 2 0 0 20 0 11 0 118326204 1063813120 127480 18446744073709551615 4194304 4228012 140736090822592 140186733640720 140186839745236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31363] ppid=31352 vsize=1038880 CPUtime=0
/proc/31355/task/31363/stat : 31363 (java) S 31352 31352 1733 0 -1 4202560 0 0 0 0 0 0 0 0 20 0 11 0 118326204 1063813120 127480 18446744073709551615 4194304 4228012 140736090822592 140186732588240 140186839745236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31364] ppid=31352 vsize=1038880 CPUtime=0.14
/proc/31355/task/31364/stat : 31364 (java) S 31352 31352 1733 0 -1 4202560 22 0 0 0 14 0 0 0 20 0 11 0 118326204 1063813120 127480 18446744073709551615 4194304 4228012 140736090822592 140186731535744 140186839746123 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31365] ppid=31352 vsize=1038880 CPUtime=0
/proc/31355/task/31365/stat : 31365 (java) S 31352 31352 1733 0 -1 4202560 6 0 0 0 0 0 0 0 20 0 11 0 118326966 1063813120 127480 18446744073709551615 4194304 4228012 140736090822592 140186730329952 140186839746123 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
Current children cumulated CPU time (s) 278.47
Current children cumulated vsize (KiB) 1048052

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

[startup+288.001 s]
/proc/loadavg: 1.07 1.07 1.01 2/71 31368
/proc/meminfo: memFree=237128/1022884 swapFree=0/0
[pid=31352] ppid=31351 vsize=9172 CPUtime=0
/proc/31352/stat : 31352 (p2cudf-full-1.1) S 31351 31352 1733 0 -1 4202496 454 292 2 1 0 0 0 0 20 0 1 0 118326181 9392128 331 18446744073709551615 4194304 5129932 140734377566112 140734377564256 140110344762462 0 65536 16781316 65538 0 0 0 17 0 0 0 1 0 0
/proc/31352/statm: 2293 331 280 229 0 53 0
[pid=31355] ppid=31352 vsize=1038880 CPUtime=284.11
/proc/31355/stat : 31355 (java) S 31352 31352 1733 0 -1 4202496 133988 0 20 0 28357 54 0 0 20 0 11 0 118326184 1063813120 127612 18446744073709551615 4194304 4228012 140736090822592 140736090813616 140186839731829 0 0 0 16800975 18446744073709551615 0 0 17 0 0 0 5 0 0
/proc/31355/statm: 259720 127612 2393 9 0 247070 0
[pid=31355/tid=31356] ppid=31352 vsize=1038880 CPUtime=256.42
/proc/31355/task/31356/stat : 31356 (java) R 31352 31352 1733 0 -1 4202560 47826 0 8 0 25616 26 0 0 20 0 11 0 118326191 1063813120 127612 18446744073709551615 4194304 4228012 140736090822592 140186846265304 140186745059017 0 4 0 16800975 0 0 0 -1 0 0 0 12 0 0
[pid=31355/tid=31357] ppid=31352 vsize=1038880 CPUtime=22.78
/proc/31355/task/31357/stat : 31357 (java) S 31352 31352 1733 0 -1 4202560 66042 0 0 0 2258 20 0 0 20 0 11 0 118326200 1063813120 127612 18446744073709551615 4194304 4228012 140736090822592 140186738904192 140186839746123 0 0 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31358] ppid=31352 vsize=1038880 CPUtime=0
/proc/31355/task/31358/stat : 31358 (java) S 31352 31352 1733 0 -1 4202560 16 0 0 0 0 0 0 0 20 0 11 0 118326200 1063813120 127612 18446744073709551615 4194304 4228012 140736090822592 140186737850384 140186839745236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31359] ppid=31352 vsize=1038880 CPUtime=0
/proc/31355/task/31359/stat : 31359 (java) S 31352 31352 1733 0 -1 4202560 8 0 0 0 0 0 0 0 20 0 11 0 118326200 1063813120 127612 18446744073709551615 4194304 4228012 140736090822592 140186736797600 140186839745236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31360] ppid=31352 vsize=1038880 CPUtime=0
/proc/31355/task/31360/stat : 31360 (java) S 31352 31352 1733 0 -1 4202560 0 0 0 0 0 0 0 0 20 0 11 0 118326204 1063813120 127612 18446744073709551615 4194304 4228012 140736090822592 140186735746032 140186839753760 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31361] ppid=31352 vsize=1038880 CPUtime=2.31
/proc/31355/task/31361/stat : 31361 (java) S 31352 31352 1733 0 -1 4202560 11166 0 0 0 226 5 0 0 20 0 11 0 118326204 1063813120 127612 18446744073709551615 4194304 4228012 140736090822592 140186734693392 140186839745236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31362] ppid=31352 vsize=1038880 CPUtime=2.42
/proc/31355/task/31362/stat : 31362 (java) S 31352 31352 1733 0 -1 4202560 7648 0 0 0 240 2 0 0 20 0 11 0 118326204 1063813120 127612 18446744073709551615 4194304 4228012 140736090822592 140186733640720 140186839745236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31363] ppid=31352 vsize=1038880 CPUtime=0
/proc/31355/task/31363/stat : 31363 (java) S 31352 31352 1733 0 -1 4202560 0 0 0 0 0 0 0 0 20 0 11 0 118326204 1063813120 127612 18446744073709551615 4194304 4228012 140736090822592 140186732588240 140186839745236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31364] ppid=31352 vsize=1038880 CPUtime=0.14
/proc/31355/task/31364/stat : 31364 (java) S 31352 31352 1733 0 -1 4202560 22 0 0 0 14 0 0 0 20 0 11 0 118326204 1063813120 127612 18446744073709551615 4194304 4228012 140736090822592 140186731535744 140186839746123 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31365] ppid=31352 vsize=1038880 CPUtime=0
/proc/31355/task/31365/stat : 31365 (java) S 31352 31352 1733 0 -1 4202560 6 0 0 0 0 0 0 0 20 0 11 0 118326966 1063813120 127612 18446744073709551615 4194304 4228012 140736090822592 140186730329952 140186839746123 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
Current children cumulated CPU time (s) 284.11
Current children cumulated vsize (KiB) 1048052

[startup+291.201 s]
/proc/loadavg: 1.07 1.07 1.01 2/71 31368
/proc/meminfo: memFree=237128/1022884 swapFree=0/0
[pid=31352] ppid=31351 vsize=9172 CPUtime=0
/proc/31352/stat : 31352 (p2cudf-full-1.1) S 31351 31352 1733 0 -1 4202496 454 292 2 1 0 0 0 0 20 0 1 0 118326181 9392128 331 18446744073709551615 4194304 5129932 140734377566112 140734377564256 140110344762462 0 65536 16781316 65538 0 0 0 17 0 0 0 1 0 0
/proc/31352/statm: 2293 331 280 229 0 53 0
[pid=31355] ppid=31352 vsize=1038880 CPUtime=287.28
/proc/31355/stat : 31355 (java) S 31352 31352 1733 0 -1 4202496 133988 0 20 0 28674 54 0 0 20 0 11 0 118326184 1063813120 127612 18446744073709551615 4194304 4228012 140736090822592 140736090813616 140186839731829 0 0 0 16800975 18446744073709551615 0 0 17 0 0 0 5 0 0
/proc/31355/statm: 259720 127612 2393 9 0 247070 0
[pid=31355/tid=31356] ppid=31352 vsize=1038880 CPUtime=259.59
/proc/31355/task/31356/stat : 31356 (java) R 31352 31352 1733 0 -1 4202560 47826 0 8 0 25933 26 0 0 20 0 11 0 118326191 1063813120 127612 18446744073709551615 4194304 4228012 140736090822592 140186846265304 140186743729344 0 4 0 16800975 0 0 0 -1 0 0 0 12 0 0
[pid=31355/tid=31357] ppid=31352 vsize=1038880 CPUtime=22.78
/proc/31355/task/31357/stat : 31357 (java) S 31352 31352 1733 0 -1 4202560 66042 0 0 0 2258 20 0 0 20 0 11 0 118326200 1063813120 127612 18446744073709551615 4194304 4228012 140736090822592 140186738904192 140186839746123 0 0 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31358] ppid=31352 vsize=1038880 CPUtime=0
/proc/31355/task/31358/stat : 31358 (java) S 31352 31352 1733 0 -1 4202560 16 0 0 0 0 0 0 0 20 0 11 0 118326200 1063813120 127612 18446744073709551615 4194304 4228012 140736090822592 140186737850384 140186839745236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31359] ppid=31352 vsize=1038880 CPUtime=0
/proc/31355/task/31359/stat : 31359 (java) S 31352 31352 1733 0 -1 4202560 8 0 0 0 0 0 0 0 20 0 11 0 118326200 1063813120 127612 18446744073709551615 4194304 4228012 140736090822592 140186736797600 140186839745236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31360] ppid=31352 vsize=1038880 CPUtime=0
/proc/31355/task/31360/stat : 31360 (java) S 31352 31352 1733 0 -1 4202560 0 0 0 0 0 0 0 0 20 0 11 0 118326204 1063813120 127612 18446744073709551615 4194304 4228012 140736090822592 140186735746032 140186839753760 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31361] ppid=31352 vsize=1038880 CPUtime=2.31
/proc/31355/task/31361/stat : 31361 (java) S 31352 31352 1733 0 -1 4202560 11166 0 0 0 226 5 0 0 20 0 11 0 118326204 1063813120 127612 18446744073709551615 4194304 4228012 140736090822592 140186734693392 140186839745236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31362] ppid=31352 vsize=1038880 CPUtime=2.42
/proc/31355/task/31362/stat : 31362 (java) S 31352 31352 1733 0 -1 4202560 7648 0 0 0 240 2 0 0 20 0 11 0 118326204 1063813120 127612 18446744073709551615 4194304 4228012 140736090822592 140186733640720 140186839745236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31363] ppid=31352 vsize=1038880 CPUtime=0
/proc/31355/task/31363/stat : 31363 (java) S 31352 31352 1733 0 -1 4202560 0 0 0 0 0 0 0 0 20 0 11 0 118326204 1063813120 127612 18446744073709551615 4194304 4228012 140736090822592 140186732588240 140186839745236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31364] ppid=31352 vsize=1038880 CPUtime=0.14
/proc/31355/task/31364/stat : 31364 (java) S 31352 31352 1733 0 -1 4202560 22 0 0 0 14 0 0 0 20 0 11 0 118326204 1063813120 127612 18446744073709551615 4194304 4228012 140736090822592 140186731535744 140186839746123 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31365] ppid=31352 vsize=1038880 CPUtime=0
/proc/31355/task/31365/stat : 31365 (java) S 31352 31352 1733 0 -1 4202560 6 0 0 0 0 0 0 0 20 0 11 0 118326966 1063813120 127612 18446744073709551615 4194304 4228012 140736090822592 140186730329952 140186839746123 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
Current children cumulated CPU time (s) 287.28
Current children cumulated vsize (KiB) 1048052

[startup+292.801 s]
/proc/loadavg: 1.07 1.07 1.01 2/74 31390
/proc/meminfo: memFree=223464/1022884 swapFree=0/0
[pid=31352] ppid=31351 vsize=9172 CPUtime=0
/proc/31352/stat : 31352 (p2cudf-full-1.1) S 31351 31352 1733 0 -1 4202496 454 292 2 1 0 0 0 0 20 0 1 0 118326181 9392128 331 18446744073709551615 4194304 5129932 140734377566112 140734377564256 140110344762462 0 65536 16781316 65538 0 0 0 17 0 0 0 1 0 0
/proc/31352/statm: 2293 331 280 229 0 53 0
[pid=31355] ppid=31352 vsize=1038880 CPUtime=288.64
/proc/31355/stat : 31355 (java) S 31352 31352 1733 0 -1 4202496 134714 0 20 0 28810 54 0 0 20 0 11 0 118326184 1063813120 128338 18446744073709551615 4194304 4228012 140736090822592 140736090813616 140186839731829 0 0 0 16800975 18446744073709551615 0 0 17 0 0 0 5 0 0
/proc/31355/statm: 259720 128338 2393 9 0 247070 0
[pid=31355/tid=31356] ppid=31352 vsize=1038880 CPUtime=260.58
/proc/31355/task/31356/stat : 31356 (java) R 31352 31352 1733 0 -1 4202560 47826 0 8 0 26032 26 0 0 20 0 11 0 118326191 1063813120 128338 18446744073709551615 4194304 4228012 140736090822592 140186846265304 140186744480368 0 4 0 16800975 0 0 0 -1 0 0 0 12 0 0
[pid=31355/tid=31357] ppid=31352 vsize=1038880 CPUtime=23.14
/proc/31355/task/31357/stat : 31357 (java) S 31352 31352 1733 0 -1 4202560 66768 0 0 0 2294 20 0 0 20 0 11 0 118326200 1063813120 128338 18446744073709551615 4194304 4228012 140736090822592 140186738904192 140186839746123 0 0 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31358] ppid=31352 vsize=1038880 CPUtime=0
/proc/31355/task/31358/stat : 31358 (java) S 31352 31352 1733 0 -1 4202560 16 0 0 0 0 0 0 0 20 0 11 0 118326200 1063813120 128338 18446744073709551615 4194304 4228012 140736090822592 140186737850384 140186839745236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31359] ppid=31352 vsize=1038880 CPUtime=0
/proc/31355/task/31359/stat : 31359 (java) S 31352 31352 1733 0 -1 4202560 8 0 0 0 0 0 0 0 20 0 11 0 118326200 1063813120 128338 18446744073709551615 4194304 4228012 140736090822592 140186736797600 140186839745236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31360] ppid=31352 vsize=1038880 CPUtime=0
/proc/31355/task/31360/stat : 31360 (java) S 31352 31352 1733 0 -1 4202560 0 0 0 0 0 0 0 0 20 0 11 0 118326204 1063813120 128338 18446744073709551615 4194304 4228012 140736090822592 140186735746032 140186839753760 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31361] ppid=31352 vsize=1038880 CPUtime=2.31
/proc/31355/task/31361/stat : 31361 (java) S 31352 31352 1733 0 -1 4202560 11166 0 0 0 226 5 0 0 20 0 11 0 118326204 1063813120 128338 18446744073709551615 4194304 4228012 140736090822592 140186734693392 140186839745236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31362] ppid=31352 vsize=1038880 CPUtime=2.42
/proc/31355/task/31362/stat : 31362 (java) S 31352 31352 1733 0 -1 4202560 7648 0 0 0 240 2 0 0 20 0 11 0 118326204 1063813120 128338 18446744073709551615 4194304 4228012 140736090822592 140186733640720 140186839745236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31363] ppid=31352 vsize=1038880 CPUtime=0
/proc/31355/task/31363/stat : 31363 (java) S 31352 31352 1733 0 -1 4202560 0 0 0 0 0 0 0 0 20 0 11 0 118326204 1063813120 128338 18446744073709551615 4194304 4228012 140736090822592 140186732588240 140186839745236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31364] ppid=31352 vsize=1038880 CPUtime=0.14
/proc/31355/task/31364/stat : 31364 (java) S 31352 31352 1733 0 -1 4202560 22 0 0 0 14 0 0 0 20 0 11 0 118326204 1063813120 128338 18446744073709551615 4194304 4228012 140736090822592 140186731535744 140186839746123 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31365] ppid=31352 vsize=1038880 CPUtime=0
/proc/31355/task/31365/stat : 31365 (java) S 31352 31352 1733 0 -1 4202560 6 0 0 0 0 0 0 0 20 0 11 0 118326966 1063813120 128338 18446744073709551615 4194304 4228012 140736090822592 140186730329952 140186839746123 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
Current children cumulated CPU time (s) 288.64
Current children cumulated vsize (KiB) 1048052

[startup+293.601 s]
/proc/loadavg: 1.07 1.07 1.01 2/74 31390
/proc/meminfo: memFree=223464/1022884 swapFree=0/0
[pid=31352] ppid=31351 vsize=9172 CPUtime=0
/proc/31352/stat : 31352 (p2cudf-full-1.1) S 31351 31352 1733 0 -1 4202496 454 292 2 1 0 0 0 0 20 0 1 0 118326181 9392128 331 18446744073709551615 4194304 5129932 140734377566112 140734377564256 140110344762462 0 65536 16781316 65538 0 0 0 17 0 0 0 1 0 0
/proc/31352/statm: 2293 331 280 229 0 53 0
[pid=31355] ppid=31352 vsize=1039908 CPUtime=288.85
/proc/31355/stat : 31355 (java) S 31352 31352 1733 0 -1 4202496 134730 0 20 0 28830 55 0 0 20 0 11 0 118326184 1064865792 128352 18446744073709551615 4194304 4228012 140736090822592 140736090813616 140186839731829 0 0 0 16800975 18446744073709551615 0 0 17 0 0 0 5 0 0
/proc/31355/statm: 259977 128352 2393 9 0 247327 0
[pid=31355/tid=31356] ppid=31352 vsize=1039908 CPUtime=260.66
/proc/31355/task/31356/stat : 31356 (java) S 31352 31352 1733 0 -1 4202560 47832 0 8 0 26040 26 0 0 20 0 11 0 118326191 1064865792 128352 18446744073709551615 4194304 4228012 140736090822592 140186846266288 140186839745236 0 4 0 16800975 0 0 0 -1 0 0 0 12 0 0
[pid=31355/tid=31357] ppid=31352 vsize=1039908 CPUtime=23.14
/proc/31355/task/31357/stat : 31357 (java) S 31352 31352 1733 0 -1 4202560 66768 0 0 0 2294 20 0 0 20 0 11 0 118326200 1064865792 128352 18446744073709551615 4194304 4228012 140736090822592 140186738904192 140186839746123 0 0 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31358] ppid=31352 vsize=1039908 CPUtime=0
/proc/31355/task/31358/stat : 31358 (java) S 31352 31352 1733 0 -1 4202560 16 0 0 0 0 0 0 0 20 0 11 0 118326200 1064865792 128352 18446744073709551615 4194304 4228012 140736090822592 140186737850384 140186839745236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31359] ppid=31352 vsize=1039908 CPUtime=0
/proc/31355/task/31359/stat : 31359 (java) S 31352 31352 1733 0 -1 4202560 8 0 0 0 0 0 0 0 20 0 11 0 118326200 1064865792 128352 18446744073709551615 4194304 4228012 140736090822592 140186736797600 140186839745236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31360] ppid=31352 vsize=1039908 CPUtime=0
/proc/31355/task/31360/stat : 31360 (java) S 31352 31352 1733 0 -1 4202560 0 0 0 0 0 0 0 0 20 0 11 0 118326204 1064865792 128352 18446744073709551615 4194304 4228012 140736090822592 140186735746032 140186839753760 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31361] ppid=31352 vsize=1039908 CPUtime=2.32
/proc/31355/task/31361/stat : 31361 (java) S 31352 31352 1733 0 -1 4202560 11166 0 0 0 227 5 0 0 20 0 11 0 118326204 1064865792 128352 18446744073709551615 4194304 4228012 140736090822592 140186734693392 140186839745236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31362] ppid=31352 vsize=1039908 CPUtime=2.44
/proc/31355/task/31362/stat : 31362 (java) S 31352 31352 1733 0 -1 4202560 7648 0 0 0 242 2 0 0 20 0 11 0 118326204 1064865792 128352 18446744073709551615 4194304 4228012 140736090822592 140186733640720 140186839745236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31363] ppid=31352 vsize=1039908 CPUtime=0
/proc/31355/task/31363/stat : 31363 (java) S 31352 31352 1733 0 -1 4202560 0 0 0 0 0 0 0 0 20 0 11 0 118326204 1064865792 128352 18446744073709551615 4194304 4228012 140736090822592 140186732588240 140186839745236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31364] ppid=31352 vsize=1039908 CPUtime=0.14
/proc/31355/task/31364/stat : 31364 (java) S 31352 31352 1733 0 -1 4202560 22 0 0 0 14 0 0 0 20 0 11 0 118326204 1064865792 128352 18446744073709551615 4194304 4228012 140736090822592 140186731535744 140186839746123 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
Current children cumulated CPU time (s) 288.85
Current children cumulated vsize (KiB) 1049080

[startup+293.822 s]
/proc/loadavg: 1.07 1.07 1.01 5/70 31403
/proc/meminfo: memFree=215048/1022884 swapFree=0/0
[pid=31352] ppid=31351 vsize=9172 CPUtime=0
/proc/31352/stat : 31352 (p2cudf-full-1.1) S 31351 31352 1733 0 -1 4202496 454 292 2 1 0 0 0 0 20 0 1 0 118326181 9392128 331 18446744073709551615 4194304 5129932 140734377566112 140734377564256 140110344762462 0 65536 16781316 65538 0 0 0 17 0 0 0 1 0 0
/proc/31352/statm: 2293 331 280 229 0 53 0
[pid=31355] ppid=31352 vsize=1039908 CPUtime=289.02
/proc/31355/stat : 31355 (java) S 31352 31352 1733 0 -1 4202496 134731 0 20 0 28842 60 0 0 20 0 11 0 118326184 1064865792 128353 18446744073709551615 4194304 4228012 140736090822592 140736090813616 140186839731829 0 0 0 16800975 18446744073709551615 0 0 17 0 0 0 5 0 0
/proc/31355/statm: 259977 128353 2394 9 0 247327 0
[pid=31355/tid=31356] ppid=31352 vsize=1039908 CPUtime=260.66
/proc/31355/task/31356/stat : 31356 (java) S 31352 31352 1733 0 -1 4202560 47832 0 8 0 26040 26 0 0 20 0 11 0 118326191 1064865792 128353 18446744073709551615 4194304 4228012 140736090822592 140186846266288 140186839745236 0 4 0 16800975 0 0 0 -1 0 0 0 12 0 0
[pid=31355/tid=31357] ppid=31352 vsize=1039908 CPUtime=23.14
/proc/31355/task/31357/stat : 31357 (java) S 31352 31352 1733 0 -1 4202560 66768 0 0 0 2294 20 0 0 20 0 11 0 118326200 1064865792 128353 18446744073709551615 4194304 4228012 140736090822592 140186738904192 140186839746123 0 0 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31358] ppid=31352 vsize=1039908 CPUtime=0
/proc/31355/task/31358/stat : 31358 (java) S 31352 31352 1733 0 -1 4202560 16 0 0 0 0 0 0 0 20 0 11 0 118326200 1064865792 128353 18446744073709551615 4194304 4228012 140736090822592 140186737850384 140186839745236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31359] ppid=31352 vsize=1039908 CPUtime=0
/proc/31355/task/31359/stat : 31359 (java) S 31352 31352 1733 0 -1 4202560 8 0 0 0 0 0 0 0 20 0 11 0 118326200 1064865792 128353 18446744073709551615 4194304 4228012 140736090822592 140186736797600 140186839745236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31360] ppid=31352 vsize=1039908 CPUtime=0
/proc/31355/task/31360/stat : 31360 (java) S 31352 31352 1733 0 -1 4202560 0 0 0 0 0 0 0 0 20 0 11 0 118326204 1064865792 128353 18446744073709551615 4194304 4228012 140736090822592 140186735746032 140186839753760 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31361] ppid=31352 vsize=1039908 CPUtime=2.36
/proc/31355/task/31361/stat : 31361 (java) S 31352 31352 1733 0 -1 4202560 11166 0 0 0 231 5 0 0 20 0 11 0 118326204 1064865792 128353 18446744073709551615 4194304 4228012 140736090822592 140186734693392 140186839745236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31362] ppid=31352 vsize=1039908 CPUtime=2.49
/proc/31355/task/31362/stat : 31362 (java) R 31352 31352 1733 0 -1 4202560 7649 0 0 0 247 2 0 0 20 0 11 0 118326204 1064865792 128353 18446744073709551615 4194304 4228012 140736090822592 140186733640464 140186832985247 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31363] ppid=31352 vsize=1039908 CPUtime=0
/proc/31355/task/31363/stat : 31363 (java) S 31352 31352 1733 0 -1 4202560 0 0 0 0 0 0 0 0 20 0 11 0 118326204 1064865792 128353 18446744073709551615 4194304 4228012 140736090822592 140186732588240 140186839745236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31364] ppid=31352 vsize=1039908 CPUtime=0.14
/proc/31355/task/31364/stat : 31364 (java) S 31352 31352 1733 0 -1 4202560 22 0 0 0 14 0 0 0 20 0 11 0 118326204 1064865792 128353 18446744073709551615 4194304 4228012 140736090822592 140186731535744 140186839746123 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=31355/tid=31391] ppid=31352 vsize=1039908 CPUtime=0.19
/proc/31355/task/31391/stat : 31391 (java) R 31352 31352 1733 0 -1 4202560 10 0 0 0 13 6 0 0 20 0 11 0 118355470 1064865792 128353 18446744073709551615 4194304 4228012 140736090822592 140186729269088 140186839757101 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
Current children cumulated CPU time (s) 289.02
Current children cumulated vsize (KiB) 1049080

[startup+293.909 s]
/proc/loadavg: 1.07 1.07 1.01 5/70 31403
/proc/meminfo: memFree=215048/1022884 swapFree=0/0
[pid=31352] ppid=31351 vsize=9172 CPUtime=0
/proc/31352/stat : 31352 (p2cudf-full-1.1) S 31351 31352 1733 0 -1 4202496 454 292 2 1 0 0 0 0 20 0 1 0 118326181 9392128 331 18446744073709551615 4194304 5129932 140734377566112 140734377564256 140110344762462 0 65536 16781316 65538 0 0 0 17 0 0 0 1 0 0
/proc/31352/statm: 2293 331 280 229 0 53 0
[pid=31355] ppid=31352 vsize=0 CPUtime=289.09
/proc/31355/stat : 31355 (java) Z 31352 31352 1733 0 -1 4203532 134741 0 20 0 28846 63 0 0 20 0 2 0 118326184 0 0 18446744073709551615 0 0 0 0 0 0 0 0 16800975 18446744073709551615 0 0 17 0 0 0 5 0 0
/proc/31355/statm: 0 0 0 0 0 0 0
[pid=31355/tid=31391] ppid=31352 vsize=0 CPUtime=0.25
/proc/31355/task/31391/stat : 31391 (java) R 31352 31352 1733 0 -1 4203588 10 0 0 0 15 10 0 0 20 0 2 0 118355470 0 0 18446744073709551615 0 0 0 0 0 0 4 0 16800975 18446744073709551615 0 0 -1 0 0 0 0 0 0
Current children cumulated CPU time (s) 289.09
Current children cumulated vsize (KiB) 9172

Child status: 0
Real time (s): 293.91
CPU time (s): 289.106
CPU user time (s): 288.47
CPU system time (s): 0.636039
CPU usage (%): 98.3656
Max. virtual memory (cumulated for all children) (KiB): 1054964

getrusage(RUSAGE_CHILDREN,...) data:
user time used= 288.47
system time used= 0.636039
maximum resident set size= 513444
integral shared memory size= 0
integral unshared data size= 0
integral unshared stack size= 0
page reclaims= 135500
page faults= 23
swaps= 0
block input operations= 26624
block output operations= 736
messages sent= 0
messages received= 0
signals received= 0
voluntary context switches= 7263
involuntary context switches= 41349

runsolver used 0.940058 second user time and 2.14813 second system time

The end