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/trendy-size/install/rand179.cudf.log.runsolver /home/competition/p2cudf-full-1.15/p2cudf-full-1.15 /home/competition/data/install/rand179.cudf /tmp/misc2012/2012-09-02-22:42/full/p2cudf-full-1.15/trendy-size/install/rand179.cudf.result -count(removed),-sum(solution,installedsize),-notuptodate(solution),-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.00 1.02 1.00 2/60 24334
/proc/meminfo: memFree=639340/1022884 swapFree=0/0
[pid=24334] ppid=24333 vsize=3152 CPUtime=0
/proc/24334/stat : 24334 (runsolver) R 24333 32685 32685 0 -1 4202560 0 0 0 0 0 0 0 0 20 0 1 0 41574393 3227648 32 18446744073709551615 134512640 134586868 4293317296 4293315344 4151886896 0 0 16781316 24578 0 0 0 17 0 0 0 0 0 0
/proc/24334/statm: 788 32 0 19 0 73 0
Current StackSize limit: 8192 KiB


[startup+0.15651 s]
/proc/loadavg: 1.00 1.02 1.00 2/60 24334
/proc/meminfo: memFree=639340/1022884 swapFree=0/0
[pid=24334] ppid=24333 vsize=9168 CPUtime=0
/proc/24334/stat : 24334 (p2cudf-full-1.1) S 24333 24334 32685 0 -1 4202496 457 292 0 0 0 0 0 0 20 0 1 0 41574393 9388032 331 18446744073709551615 4194304 5129932 140734090799488 140734090797632 139818967401566 0 65536 16781316 65538 0 0 0 17 0 0 0 0 0 0
/proc/24334/statm: 2292 331 280 229 0 52 0
Current children cumulated CPU time (s) 0
Current children cumulated vsize (KiB) 9168

[startup+0.20028 s]
/proc/loadavg: 1.00 1.02 1.00 2/60 24334
/proc/meminfo: memFree=639340/1022884 swapFree=0/0
[pid=24334] ppid=24333 vsize=9168 CPUtime=0
/proc/24334/stat : 24334 (p2cudf-full-1.1) S 24333 24334 32685 0 -1 4202496 457 292 0 0 0 0 0 0 20 0 1 0 41574393 9388032 331 18446744073709551615 4194304 5129932 140734090799488 140734090797632 139818967401566 0 65536 16781316 65538 0 0 0 17 0 0 0 0 0 0
/proc/24334/statm: 2292 331 280 229 0 52 0
Current children cumulated CPU time (s) 0
Current children cumulated vsize (KiB) 9168

[startup+0.300256 s]
/proc/loadavg: 1.00 1.02 1.00 2/60 24334
/proc/meminfo: memFree=639340/1022884 swapFree=0/0
[pid=24334] ppid=24333 vsize=9168 CPUtime=0
/proc/24334/stat : 24334 (p2cudf-full-1.1) S 24333 24334 32685 0 -1 4202496 457 292 0 0 0 0 0 0 20 0 1 0 41574393 9388032 331 18446744073709551615 4194304 5129932 140734090799488 140734090797632 139818967401566 0 65536 16781316 65538 0 0 0 17 0 0 0 0 0 0
/proc/24334/statm: 2292 331 280 229 0 52 0
Current children cumulated CPU time (s) 0
Current children cumulated vsize (KiB) 9168

[startup+0.700216 s]
/proc/loadavg: 1.00 1.02 1.00 2/60 24334
/proc/meminfo: memFree=639340/1022884 swapFree=0/0
[pid=24334] ppid=24333 vsize=9168 CPUtime=0
/proc/24334/stat : 24334 (p2cudf-full-1.1) S 24333 24334 32685 0 -1 4202496 457 292 0 0 0 0 0 0 20 0 1 0 41574393 9388032 331 18446744073709551615 4194304 5129932 140734090799488 140734090797632 139818967401566 0 65536 16781316 65538 0 0 0 17 0 0 0 0 0 0
/proc/24334/statm: 2292 331 280 229 0 52 0
Current children cumulated CPU time (s) 0
Current children cumulated vsize (KiB) 9168

[startup+1.50058 s]
/proc/loadavg: 1.00 1.02 1.00 4/71 24346
/proc/meminfo: memFree=518468/1022884 swapFree=0/0
[pid=24334] ppid=24333 vsize=9168 CPUtime=0
/proc/24334/stat : 24334 (p2cudf-full-1.1) S 24333 24334 32685 0 -1 4202496 457 292 0 0 0 0 0 0 20 0 1 0 41574393 9388032 331 18446744073709551615 4194304 5129932 140734090799488 140734090797632 139818967401566 0 65536 16781316 65538 0 0 0 17 0 0 0 0 0 0
/proc/24334/statm: 2292 331 280 229 0 52 0
[pid=24337] ppid=24334 vsize=1046248 CPUtime=1.46
/proc/24337/stat : 24337 (java) S 24334 24334 32685 0 -1 4202496 44382 0 0 0 134 12 0 0 20 0 10 0 41574393 1071357952 39595 18446744073709551615 4194304 4228012 140735982201200 140735982192224 140196663987829 0 0 0 16800975 18446744073709551615 0 0 17 0 0 0 0 0 0
/proc/24337/statm: 261562 39595 2345 9 0 248912 0
[pid=24337/tid=24338] ppid=24334 vsize=1046248 CPUtime=0.62
/proc/24337/task/24338/stat : 24338 (java) R 24334 24334 32685 0 -1 4202560 23529 0 0 0 54 8 0 0 20 0 10 0 41574394 1071357952 39595 18446744073709551615 4194304 4228012 140735982201200 140196670513856 140196568187419 0 4 0 16800975 0 0 0 -1 0 0 0 1 0 0
[pid=24337/tid=24339] ppid=24334 vsize=1046248 CPUtime=0
/proc/24337/task/24339/stat : 24339 (java) S 24334 24334 32685 0 -1 4202560 3 0 0 0 0 0 0 0 20 0 10 0 41574396 1071357952 39595 18446744073709551615 4194304 4228012 140735982201200 140196563160192 140196664002123 0 0 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24340] ppid=24334 vsize=1046248 CPUtime=0
/proc/24337/task/24340/stat : 24340 (java) S 24334 24334 32685 0 -1 4202560 15 0 0 0 0 0 0 0 20 0 10 0 41574396 1071357952 39595 18446744073709551615 4194304 4228012 140735982201200 140196562106384 140196664001236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24341] ppid=24334 vsize=1046248 CPUtime=0
/proc/24337/task/24341/stat : 24341 (java) S 24334 24334 32685 0 -1 4202560 6 0 0 0 0 0 0 0 20 0 10 0 41574396 1071357952 39595 18446744073709551615 4194304 4228012 140735982201200 140196561053600 140196664001236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24342] ppid=24334 vsize=1046248 CPUtime=0
/proc/24337/task/24342/stat : 24342 (java) S 24334 24334 32685 0 -1 4202560 1 0 0 0 0 0 0 0 20 0 10 0 41574399 1071357952 39595 18446744073709551615 4194304 4228012 140735982201200 140196560002032 140196664009760 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24343] ppid=24334 vsize=1046248 CPUtime=0.41
/proc/24337/task/24343/stat : 24343 (java) R 24334 24334 32685 0 -1 4202560 9536 0 0 0 39 2 0 0 20 0 10 0 41574399 1071357952 39595 18446744073709551615 4194304 4228012 140735982201200 140196558949136 140196650506923 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24344] ppid=24334 vsize=1046248 CPUtime=0.41
/proc/24337/task/24344/stat : 24344 (java) R 24334 24334 32685 0 -1 4202560 10027 0 0 0 39 2 0 0 20 0 10 0 41574399 1071357952 39595 18446744073709551615 4194304 4228012 140735982201200 140196557896464 140196649658550 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24345] ppid=24334 vsize=1046248 CPUtime=0
/proc/24337/task/24345/stat : 24345 (java) S 24334 24334 32685 0 -1 4202560 0 0 0 0 0 0 0 0 20 0 10 0 41574399 1071357952 39595 18446744073709551615 4194304 4228012 140735982201200 140196556844240 140196664001236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24346] ppid=24334 vsize=1046248 CPUtime=0
/proc/24337/task/24346/stat : 24346 (java) S 24334 24334 32685 0 -1 4202560 0 0 0 0 0 0 0 0 20 0 10 0 41574399 1071357952 39595 18446744073709551615 4194304 4228012 140735982201200 140196555791744 140196664002123 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
Current children cumulated CPU time (s) 1.46
Current children cumulated vsize (KiB) 1055416

[startup+3.10081 s]
/proc/loadavg: 1.00 1.02 1.00 2/71 24346
/proc/meminfo: memFree=357144/1022884 swapFree=0/0
[pid=24334] ppid=24333 vsize=9168 CPUtime=0
/proc/24334/stat : 24334 (p2cudf-full-1.1) S 24333 24334 32685 0 -1 4202496 457 292 0 0 0 0 0 0 20 0 1 0 41574393 9388032 331 18446744073709551615 4194304 5129932 140734090799488 140734090797632 139818967401566 0 65536 16781316 65538 0 0 0 17 0 0 0 0 0 0
/proc/24334/statm: 2292 331 280 229 0 52 0
[pid=24337] ppid=24334 vsize=1046248 CPUtime=3.04
/proc/24337/stat : 24337 (java) S 24334 24334 32685 0 -1 4202496 89623 0 0 0 276 28 0 0 20 0 10 0 41574393 1071357952 84836 18446744073709551615 4194304 4228012 140735982201200 140735982192224 140196663987829 0 0 0 16800975 18446744073709551615 0 0 17 0 0 0 0 0 0
/proc/24337/statm: 261562 84836 2366 9 0 248912 0
[pid=24337/tid=24338] ppid=24334 vsize=1046248 CPUtime=1.66
/proc/24337/task/24338/stat : 24338 (java) R 24334 24334 32685 0 -1 4202560 47409 0 0 0 149 17 0 0 20 0 10 0 41574394 1071357952 84836 18446744073709551615 4194304 4228012 140735982201200 140196670513856 140196568512985 0 4 0 16800975 0 0 0 -1 0 0 0 2 0 0
[pid=24337/tid=24339] ppid=24334 vsize=1046248 CPUtime=0.39
/proc/24337/task/24339/stat : 24339 (java) S 24334 24334 32685 0 -1 4202560 21344 0 0 0 33 6 0 0 20 0 10 0 41574396 1071357952 84836 18446744073709551615 4194304 4228012 140735982201200 140196563160192 140196664002123 0 0 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24340] ppid=24334 vsize=1046248 CPUtime=0
/proc/24337/task/24340/stat : 24340 (java) S 24334 24334 32685 0 -1 4202560 16 0 0 0 0 0 0 0 20 0 10 0 41574396 1071357952 84836 18446744073709551615 4194304 4228012 140735982201200 140196562106384 140196664001236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24341] ppid=24334 vsize=1046248 CPUtime=0
/proc/24337/task/24341/stat : 24341 (java) S 24334 24334 32685 0 -1 4202560 9 0 0 0 0 0 0 0 20 0 10 0 41574396 1071357952 84836 18446744073709551615 4194304 4228012 140735982201200 140196561053600 140196664001236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24342] ppid=24334 vsize=1046248 CPUtime=0
/proc/24337/task/24342/stat : 24342 (java) S 24334 24334 32685 0 -1 4202560 1 0 0 0 0 0 0 0 20 0 10 0 41574399 1071357952 84836 18446744073709551615 4194304 4228012 140735982201200 140196560002032 140196664009760 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24343] ppid=24334 vsize=1046248 CPUtime=0.51
/proc/24337/task/24343/stat : 24343 (java) S 24334 24334 32685 0 -1 4202560 9544 0 0 0 49 2 0 0 20 0 10 0 41574399 1071357952 84836 18446744073709551615 4194304 4228012 140735982201200 140196558949392 140196664001236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24344] ppid=24334 vsize=1046248 CPUtime=0.45
/proc/24337/task/24344/stat : 24344 (java) S 24334 24334 32685 0 -1 4202560 10035 0 0 0 43 2 0 0 20 0 10 0 41574399 1071357952 84836 18446744073709551615 4194304 4228012 140735982201200 140196557896720 140196664001236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24345] ppid=24334 vsize=1046248 CPUtime=0
/proc/24337/task/24345/stat : 24345 (java) S 24334 24334 32685 0 -1 4202560 0 0 0 0 0 0 0 0 20 0 10 0 41574399 1071357952 84836 18446744073709551615 4194304 4228012 140735982201200 140196556844240 140196664001236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24346] ppid=24334 vsize=1046248 CPUtime=0
/proc/24337/task/24346/stat : 24346 (java) S 24334 24334 32685 0 -1 4202560 0 0 0 0 0 0 0 0 20 0 10 0 41574399 1071357952 84836 18446744073709551615 4194304 4228012 140735982201200 140196555791744 140196664002123 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
Current children cumulated CPU time (s) 3.04
Current children cumulated vsize (KiB) 1055416

[startup+6.30074 s]
/proc/loadavg: 1.00 1.02 1.00 2/71 24346
/proc/meminfo: memFree=161720/1022884 swapFree=0/0
[pid=24334] ppid=24333 vsize=9168 CPUtime=0
/proc/24334/stat : 24334 (p2cudf-full-1.1) S 24333 24334 32685 0 -1 4202496 457 292 0 0 0 0 0 0 20 0 1 0 41574393 9388032 331 18446744073709551615 4194304 5129932 140734090799488 140734090797632 139818967401566 0 65536 16781316 65538 0 0 0 17 0 0 0 0 0 0
/proc/24334/statm: 2292 331 280 229 0 52 0
[pid=24337] ppid=24334 vsize=1046248 CPUtime=6.02
/proc/24337/stat : 24337 (java) S 24334 24334 32685 0 -1 4202496 130032 0 0 0 561 41 0 0 20 0 10 0 41574393 1071357952 123669 18446744073709551615 4194304 4228012 140735982201200 140735982192224 140196663987829 0 0 0 16800975 18446744073709551615 0 0 17 0 0 0 0 0 0
/proc/24337/statm: 261562 123669 2367 9 0 248912 0
[pid=24337/tid=24338] ppid=24334 vsize=1046248 CPUtime=3.54
/proc/24337/task/24338/stat : 24338 (java) S 24334 24334 32685 0 -1 4202560 47412 0 0 0 335 19 0 0 20 0 10 0 41574394 1071357952 123669 18446744073709551615 4194304 4228012 140735982201200 140196670521824 140196664001236 0 4 0 16800975 0 0 0 -1 0 0 0 21 0 0
[pid=24337/tid=24339] ppid=24334 vsize=1046248 CPUtime=1.42
/proc/24337/task/24339/stat : 24339 (java) R 24334 24334 32685 0 -1 4202560 61745 0 0 0 126 16 0 0 20 0 10 0 41574396 1071357952 123669 18446744073709551615 4194304 4228012 140735982201200 140196563159568 140196650849084 0 0 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24340] ppid=24334 vsize=1046248 CPUtime=0
/proc/24337/task/24340/stat : 24340 (java) S 24334 24334 32685 0 -1 4202560 16 0 0 0 0 0 0 0 20 0 10 0 41574396 1071357952 123669 18446744073709551615 4194304 4228012 140735982201200 140196562106384 140196664001236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24341] ppid=24334 vsize=1046248 CPUtime=0
/proc/24337/task/24341/stat : 24341 (java) S 24334 24334 32685 0 -1 4202560 9 0 0 0 0 0 0 0 20 0 10 0 41574396 1071357952 123669 18446744073709551615 4194304 4228012 140735982201200 140196561053600 140196664001236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24342] ppid=24334 vsize=1046248 CPUtime=0
/proc/24337/task/24342/stat : 24342 (java) S 24334 24334 32685 0 -1 4202560 1 0 0 0 0 0 0 0 20 0 10 0 41574399 1071357952 123669 18446744073709551615 4194304 4228012 140735982201200 140196560002032 140196664009760 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24343] ppid=24334 vsize=1046248 CPUtime=0.53
/proc/24337/task/24343/stat : 24343 (java) S 24334 24334 32685 0 -1 4202560 9544 0 0 0 51 2 0 0 20 0 10 0 41574399 1071357952 123669 18446744073709551615 4194304 4228012 140735982201200 140196558949392 140196664001236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24344] ppid=24334 vsize=1046248 CPUtime=0.5
/proc/24337/task/24344/stat : 24344 (java) S 24334 24334 32685 0 -1 4202560 10039 0 0 0 47 3 0 0 20 0 10 0 41574399 1071357952 123669 18446744073709551615 4194304 4228012 140735982201200 140196557896720 140196664001236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24345] ppid=24334 vsize=1046248 CPUtime=0
/proc/24337/task/24345/stat : 24345 (java) S 24334 24334 32685 0 -1 4202560 0 0 0 0 0 0 0 0 20 0 10 0 41574399 1071357952 123669 18446744073709551615 4194304 4228012 140735982201200 140196556844240 140196664001236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24346] ppid=24334 vsize=1046248 CPUtime=0
/proc/24337/task/24346/stat : 24346 (java) S 24334 24334 32685 0 -1 4202560 1 0 0 0 0 0 0 0 20 0 10 0 41574399 1071357952 123669 18446744073709551615 4194304 4228012 140735982201200 140196555791744 140196664002123 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
Current children cumulated CPU time (s) 6.02
Current children cumulated vsize (KiB) 1055416

[startup+12.7008 s]
/proc/loadavg: 1.00 1.02 1.00 3/71 24346
/proc/meminfo: memFree=27180/1022884 swapFree=0/0
[pid=24334] ppid=24333 vsize=9168 CPUtime=0
/proc/24334/stat : 24334 (p2cudf-full-1.1) S 24333 24334 32685 0 -1 4202496 457 292 0 0 0 0 0 0 20 0 1 0 41574393 9388032 331 18446744073709551615 4194304 5129932 140734090799488 140734090797632 139818967401566 0 65536 16781316 65538 0 0 0 17 0 0 0 0 0 0
/proc/24334/statm: 2292 331 280 229 0 52 0
[pid=24337] ppid=24334 vsize=1046248 CPUtime=12.3
/proc/24337/stat : 24337 (java) S 24334 24334 32685 0 -1 4202496 152762 0 0 0 1181 49 0 0 20 0 10 0 41574393 1071357952 146398 18446744073709551615 4194304 4228012 140735982201200 140735982192224 140196663987829 0 0 0 16800975 18446744073709551615 0 0 17 0 0 0 0 0 0
/proc/24337/statm: 261562 146398 2375 9 0 248912 0
[pid=24337/tid=24338] ppid=24334 vsize=1046248 CPUtime=6.21
/proc/24337/task/24338/stat : 24338 (java) R 24334 24334 32685 0 -1 4202560 47753 0 0 0 601 20 0 0 20 0 10 0 41574394 1071357952 146398 18446744073709551615 4194304 4228012 140735982201200 140196670521784 140196568695508 0 4 0 16800975 0 0 0 -1 0 0 0 25 0 0
[pid=24337/tid=24339] ppid=24334 vsize=1046248 CPUtime=2.05
/proc/24337/task/24339/stat : 24339 (java) S 24334 24334 32685 0 -1 4202560 83675 0 0 0 183 22 0 0 20 0 10 0 41574396 1071357952 146398 18446744073709551615 4194304 4228012 140735982201200 140196563160192 140196664002123 0 0 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24340] ppid=24334 vsize=1046248 CPUtime=0
/proc/24337/task/24340/stat : 24340 (java) S 24334 24334 32685 0 -1 4202560 16 0 0 0 0 0 0 0 20 0 10 0 41574396 1071357952 146398 18446744073709551615 4194304 4228012 140735982201200 140196562106384 140196664001236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24341] ppid=24334 vsize=1046248 CPUtime=0
/proc/24337/task/24341/stat : 24341 (java) S 24334 24334 32685 0 -1 4202560 9 0 0 0 0 0 0 0 20 0 10 0 41574396 1071357952 146398 18446744073709551615 4194304 4228012 140735982201200 140196561053600 140196664001236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24342] ppid=24334 vsize=1046248 CPUtime=0
/proc/24337/task/24342/stat : 24342 (java) S 24334 24334 32685 0 -1 4202560 1 0 0 0 0 0 0 0 20 0 10 0 41574399 1071357952 146398 18446744073709551615 4194304 4228012 140735982201200 140196560002032 140196664009760 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24343] ppid=24334 vsize=1046248 CPUtime=1.98
/proc/24337/task/24343/stat : 24343 (java) S 24334 24334 32685 0 -1 4202560 9836 0 0 0 196 2 0 0 20 0 10 0 41574399 1071357952 146398 18446744073709551615 4194304 4228012 140735982201200 140196558949392 140196664001236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24344] ppid=24334 vsize=1046248 CPUtime=2.03
/proc/24337/task/24344/stat : 24344 (java) R 24334 24334 32685 0 -1 4202560 10206 0 0 0 199 4 0 0 20 0 10 0 41574399 1071357952 146398 18446744073709551615 4194304 4228012 140735982201200 140196557896464 140196647816940 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24345] ppid=24334 vsize=1046248 CPUtime=0
/proc/24337/task/24345/stat : 24345 (java) S 24334 24334 32685 0 -1 4202560 0 0 0 0 0 0 0 0 20 0 10 0 41574399 1071357952 146398 18446744073709551615 4194304 4228012 140735982201200 140196556844240 140196664001236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24346] ppid=24334 vsize=1046248 CPUtime=0
/proc/24337/task/24346/stat : 24346 (java) S 24334 24334 32685 0 -1 4202560 1 0 0 0 0 0 0 0 20 0 10 0 41574399 1071357952 146398 18446744073709551615 4194304 4228012 140735982201200 140196555791744 140196664002123 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
Current children cumulated CPU time (s) 12.3
Current children cumulated vsize (KiB) 1055416

[startup+25.5009 s]
/proc/loadavg: 1.00 1.01 1.00 2/72 24347
/proc/meminfo: memFree=26552/1022884 swapFree=0/0
[pid=24334] ppid=24333 vsize=9168 CPUtime=0
/proc/24334/stat : 24334 (p2cudf-full-1.1) S 24333 24334 32685 0 -1 4202496 457 292 0 0 0 0 0 0 20 0 1 0 41574393 9388032 331 18446744073709551615 4194304 5129932 140734090799488 140734090797632 139818967401566 0 65536 16781316 65538 0 0 0 17 0 0 0 0 0 0
/proc/24334/statm: 2292 331 280 229 0 52 0
[pid=24337] ppid=24334 vsize=1047276 CPUtime=24.8
/proc/24337/stat : 24337 (java) S 24334 24334 32685 0 -1 4202496 152859 0 0 0 2430 50 0 0 20 0 11 0 41574393 1072410624 146495 18446744073709551615 4194304 4228012 140735982201200 140735982192224 140196663987829 0 0 0 16800975 18446744073709551615 0 0 17 0 0 0 0 0 0
/proc/24337/statm: 261819 146495 2380 9 0 249169 0
[pid=24337/tid=24338] ppid=24334 vsize=1047276 CPUtime=17.74
/proc/24337/task/24338/stat : 24338 (java) R 24334 24334 32685 0 -1 4202560 47798 0 0 0 1754 20 0 0 20 0 11 0 41574394 1072410624 146495 18446744073709551615 4194304 4228012 140735982201200 140196670521224 140196569372399 0 4 0 16800975 0 0 0 -1 0 0 0 28 0 0
[pid=24337/tid=24339] ppid=24334 vsize=1047276 CPUtime=2.07
/proc/24337/task/24339/stat : 24339 (java) S 24334 24334 32685 0 -1 4202560 83676 0 0 0 185 22 0 0 20 0 11 0 41574396 1072410624 146495 18446744073709551615 4194304 4228012 140735982201200 140196563160192 140196664002123 0 0 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24340] ppid=24334 vsize=1047276 CPUtime=0
/proc/24337/task/24340/stat : 24340 (java) S 24334 24334 32685 0 -1 4202560 16 0 0 0 0 0 0 0 20 0 11 0 41574396 1072410624 146495 18446744073709551615 4194304 4228012 140735982201200 140196562106384 140196664001236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24341] ppid=24334 vsize=1047276 CPUtime=0
/proc/24337/task/24341/stat : 24341 (java) S 24334 24334 32685 0 -1 4202560 9 0 0 0 0 0 0 0 20 0 11 0 41574396 1072410624 146495 18446744073709551615 4194304 4228012 140735982201200 140196561053600 140196664001236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24342] ppid=24334 vsize=1047276 CPUtime=0
/proc/24337/task/24342/stat : 24342 (java) S 24334 24334 32685 0 -1 4202560 1 0 0 0 0 0 0 0 20 0 11 0 41574399 1072410624 146495 18446744073709551615 4194304 4228012 140735982201200 140196560002032 140196664009760 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24343] ppid=24334 vsize=1047276 CPUtime=2.43
/proc/24337/task/24343/stat : 24343 (java) S 24334 24334 32685 0 -1 4202560 9852 0 0 0 241 2 0 0 20 0 11 0 41574399 1072410624 146495 18446744073709551615 4194304 4228012 140735982201200 140196558949392 140196664001236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24344] ppid=24334 vsize=1047276 CPUtime=2.51
/proc/24337/task/24344/stat : 24344 (java) S 24334 24334 32685 0 -1 4202560 10235 0 0 0 247 4 0 0 20 0 11 0 41574399 1072410624 146495 18446744073709551615 4194304 4228012 140735982201200 140196557896720 140196664001236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24345] ppid=24334 vsize=1047276 CPUtime=0
/proc/24337/task/24345/stat : 24345 (java) S 24334 24334 32685 0 -1 4202560 0 0 0 0 0 0 0 0 20 0 11 0 41574399 1072410624 146495 18446744073709551615 4194304 4228012 140735982201200 140196556844240 140196664001236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24346] ppid=24334 vsize=1047276 CPUtime=0.01
/proc/24337/task/24346/stat : 24346 (java) S 24334 24334 32685 0 -1 4202560 1 0 0 0 0 1 0 0 20 0 11 0 41574399 1072410624 146495 18446744073709551615 4194304 4228012 140735982201200 140196555791744 140196664002123 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24347] ppid=24334 vsize=1047276 CPUtime=0
/proc/24337/task/24347/stat : 24347 (java) S 24334 24334 32685 0 -1 4202560 6 0 0 0 0 0 0 0 20 0 11 0 41575688 1072410624 146495 18446744073709551615 4194304 4228012 140735982201200 140196554590048 140196664002123 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
Current children cumulated CPU time (s) 24.8
Current children cumulated vsize (KiB) 1056444

[startup+51.101 s]
/proc/loadavg: 1.08 1.03 1.01 3/72 24464
/proc/meminfo: memFree=10856/1022884 swapFree=0/0
[pid=24334] ppid=24333 vsize=9168 CPUtime=0
/proc/24334/stat : 24334 (p2cudf-full-1.1) S 24333 24334 32685 0 -1 4202496 457 292 0 0 0 0 0 0 20 0 1 0 41574393 9388032 331 18446744073709551615 4194304 5129932 140734090799488 140734090797632 139818967401566 0 65536 16781316 65538 0 0 0 17 0 0 0 0 0 0
/proc/24334/statm: 2292 331 280 229 0 52 0
[pid=24337] ppid=24334 vsize=1047276 CPUtime=45.84
/proc/24337/stat : 24337 (java) S 24334 24334 32685 0 -1 4202496 163792 0 0 0 4527 57 0 0 20 0 11 0 41574393 1072410624 157424 18446744073709551615 4194304 4228012 140735982201200 140735982192224 140196663987829 0 0 0 16800975 18446744073709551615 0 0 17 0 0 0 0 0 0
/proc/24337/statm: 261819 157424 2392 9 0 249169 0
[pid=24337/tid=24338] ppid=24334 vsize=1047276 CPUtime=36.42
/proc/24337/task/24338/stat : 24338 (java) R 24334 24334 32685 0 -1 4202560 47799 0 0 0 3620 22 0 0 20 0 11 0 41574394 1072410624 157424 18446744073709551615 4194304 4228012 140735982201200 140196670521416 140196569372454 0 4 0 16800975 0 0 0 -1 0 0 0 28 0 0
[pid=24337/tid=24339] ppid=24334 vsize=1047276 CPUtime=4.33
/proc/24337/task/24339/stat : 24339 (java) S 24334 24334 32685 0 -1 4202560 94595 0 0 0 405 28 0 0 20 0 11 0 41574396 1072410624 157424 18446744073709551615 4194304 4228012 140735982201200 140196563160192 140196664002123 0 0 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24340] ppid=24334 vsize=1047276 CPUtime=0
/proc/24337/task/24340/stat : 24340 (java) S 24334 24334 32685 0 -1 4202560 16 0 0 0 0 0 0 0 20 0 11 0 41574396 1072410624 157424 18446744073709551615 4194304 4228012 140735982201200 140196562106384 140196664001236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24341] ppid=24334 vsize=1047276 CPUtime=0
/proc/24337/task/24341/stat : 24341 (java) S 24334 24334 32685 0 -1 4202560 9 0 0 0 0 0 0 0 20 0 11 0 41574396 1072410624 157424 18446744073709551615 4194304 4228012 140735982201200 140196561053600 140196664001236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24342] ppid=24334 vsize=1047276 CPUtime=0
/proc/24337/task/24342/stat : 24342 (java) S 24334 24334 32685 0 -1 4202560 1 0 0 0 0 0 0 0 20 0 11 0 41574399 1072410624 157424 18446744073709551615 4194304 4228012 140735982201200 140196560002032 140196664009760 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24343] ppid=24334 vsize=1047276 CPUtime=2.47
/proc/24337/task/24343/stat : 24343 (java) S 24334 24334 32685 0 -1 4202560 9854 0 0 0 245 2 0 0 20 0 11 0 41574399 1072410624 157424 18446744073709551615 4194304 4228012 140735982201200 140196558949392 140196664001236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24344] ppid=24334 vsize=1047276 CPUtime=2.56
/proc/24337/task/24344/stat : 24344 (java) S 24334 24334 32685 0 -1 4202560 10243 0 0 0 252 4 0 0 20 0 11 0 41574399 1072410624 157424 18446744073709551615 4194304 4228012 140735982201200 140196557896720 140196664001236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24345] ppid=24334 vsize=1047276 CPUtime=0
/proc/24337/task/24345/stat : 24345 (java) S 24334 24334 32685 0 -1 4202560 0 0 0 0 0 0 0 0 20 0 11 0 41574399 1072410624 157424 18446744073709551615 4194304 4228012 140735982201200 140196556844240 140196664001236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24346] ppid=24334 vsize=1047276 CPUtime=0.02
/proc/24337/task/24346/stat : 24346 (java) S 24334 24334 32685 0 -1 4202560 4 0 0 0 0 2 0 0 20 0 11 0 41574399 1072410624 157424 18446744073709551615 4194304 4228012 140735982201200 140196555791744 140196664002123 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24347] ppid=24334 vsize=1047276 CPUtime=0
/proc/24337/task/24347/stat : 24347 (java) S 24334 24334 32685 0 -1 4202560 6 0 0 0 0 0 0 0 20 0 11 0 41575688 1072410624 157424 18446744073709551615 4194304 4228012 140735982201200 140196554590048 140196664002123 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
Current children cumulated CPU time (s) 45.84
Current children cumulated vsize (KiB) 1056444

[startup+102.301 s]
/proc/loadavg: 1.03 1.02 1.00 3/76 24629
/proc/meminfo: memFree=16844/1022884 swapFree=0/0
[pid=24334] ppid=24333 vsize=9168 CPUtime=0
/proc/24334/stat : 24334 (p2cudf-full-1.1) S 24333 24334 32685 0 -1 4202496 457 292 0 0 0 0 0 0 20 0 1 0 41574393 9388032 331 18446744073709551615 4194304 5129932 140734090799488 140734090797632 139818967401566 0 65536 16781316 65538 0 0 0 17 0 0 0 0 0 0
/proc/24334/statm: 2292 331 280 229 0 52 0
[pid=24337] ppid=24334 vsize=1047276 CPUtime=95.29
/proc/24337/stat : 24337 (java) S 24334 24334 32685 0 -1 4202496 164385 0 0 0 9470 59 0 0 20 0 11 0 41574393 1072410624 157996 18446744073709551615 4194304 4228012 140735982201200 140735982192224 140196663987829 0 0 0 16800975 18446744073709551615 0 0 17 0 0 0 0 0 0
/proc/24337/statm: 261819 157996 2379 9 0 249169 0
[pid=24337/tid=24338] ppid=24334 vsize=1047276 CPUtime=82.37
/proc/24337/task/24338/stat : 24338 (java) R 24334 24334 32685 0 -1 4202560 47799 0 0 0 8213 24 0 0 20 0 11 0 41574394 1072410624 157996 18446744073709551615 4194304 4228012 140735982201200 140196670521416 140196568778304 0 4 0 16800975 0 0 0 -1 0 0 0 28 0 0
[pid=24337/tid=24339] ppid=24334 vsize=1047276 CPUtime=7.77
/proc/24337/task/24339/stat : 24339 (java) S 24334 24334 32685 0 -1 4202560 95182 0 0 0 749 28 0 0 20 0 11 0 41574396 1072410624 157996 18446744073709551615 4194304 4228012 140735982201200 140196563160192 140196664002123 0 0 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24340] ppid=24334 vsize=1047276 CPUtime=0
/proc/24337/task/24340/stat : 24340 (java) S 24334 24334 32685 0 -1 4202560 16 0 0 0 0 0 0 0 20 0 11 0 41574396 1072410624 157996 18446744073709551615 4194304 4228012 140735982201200 140196562106384 140196664001236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24341] ppid=24334 vsize=1047276 CPUtime=0
/proc/24337/task/24341/stat : 24341 (java) S 24334 24334 32685 0 -1 4202560 9 0 0 0 0 0 0 0 20 0 11 0 41574396 1072410624 157996 18446744073709551615 4194304 4228012 140735982201200 140196561053600 140196664001236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24342] ppid=24334 vsize=1047276 CPUtime=0
/proc/24337/task/24342/stat : 24342 (java) S 24334 24334 32685 0 -1 4202560 1 0 0 0 0 0 0 0 20 0 11 0 41574399 1072410624 157996 18446744073709551615 4194304 4228012 140735982201200 140196560002032 140196664009760 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24343] ppid=24334 vsize=1047276 CPUtime=2.48
/proc/24337/task/24343/stat : 24343 (java) S 24334 24334 32685 0 -1 4202560 9854 0 0 0 246 2 0 0 20 0 11 0 41574399 1072410624 157996 18446744073709551615 4194304 4228012 140735982201200 140196558949392 140196664001236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24344] ppid=24334 vsize=1047276 CPUtime=2.58
/proc/24337/task/24344/stat : 24344 (java) S 24334 24334 32685 0 -1 4202560 10243 0 0 0 254 4 0 0 20 0 11 0 41574399 1072410624 157996 18446744073709551615 4194304 4228012 140735982201200 140196557896720 140196664001236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24345] ppid=24334 vsize=1047276 CPUtime=0
/proc/24337/task/24345/stat : 24345 (java) S 24334 24334 32685 0 -1 4202560 0 0 0 0 0 0 0 0 20 0 11 0 41574399 1072410624 157996 18446744073709551615 4194304 4228012 140735982201200 140196556844240 140196664001236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24346] ppid=24334 vsize=1047276 CPUtime=0.05
/proc/24337/task/24346/stat : 24346 (java) S 24334 24334 32685 0 -1 4202560 10 0 0 0 0 5 0 0 20 0 11 0 41574399 1072410624 157996 18446744073709551615 4194304 4228012 140735982201200 140196555791744 140196664002123 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24347] ppid=24334 vsize=1047276 CPUtime=0
/proc/24337/task/24347/stat : 24347 (java) S 24334 24334 32685 0 -1 4202560 6 0 0 0 0 0 0 0 20 0 11 0 41575688 1072410624 157996 18446744073709551615 4194304 4228012 140735982201200 140196554590048 140196664002123 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
Current children cumulated CPU time (s) 95.29
Current children cumulated vsize (KiB) 1056444

[startup+162.301 s]
/proc/loadavg: 1.16 1.06 1.01 2/76 24796
/proc/meminfo: memFree=10776/1022884 swapFree=0/0
[pid=24334] ppid=24333 vsize=9168 CPUtime=0
/proc/24334/stat : 24334 (p2cudf-full-1.1) S 24333 24334 32685 0 -1 4202496 457 292 0 0 0 0 0 0 20 0 1 0 41574393 9388032 331 18446744073709551615 4194304 5129932 140734090799488 140734090797632 139818967401566 0 65536 16781316 65538 0 0 0 17 0 0 0 0 0 0
/proc/24334/statm: 2292 331 280 229 0 52 0
[pid=24337] ppid=24334 vsize=1047276 CPUtime=151.52
/proc/24337/stat : 24337 (java) S 24334 24334 32685 0 -1 4202496 164392 0 0 0 15092 60 0 0 20 0 11 0 41574393 1072410624 157996 18446744073709551615 4194304 4228012 140735982201200 140735982192224 140196663987829 0 0 0 16800975 18446744073709551615 0 0 17 0 0 0 0 0 0
/proc/24337/statm: 261819 157996 2379 9 0 249169 0
[pid=24337/tid=24338] ppid=24334 vsize=1047276 CPUtime=136.88
/proc/24337/task/24338/stat : 24338 (java) R 24334 24334 32685 0 -1 4202560 47799 0 0 0 13664 24 0 0 20 0 11 0 41574394 1072410624 157996 18446744073709551615 4194304 4228012 140735982201200 140196670521416 140196569372399 0 4 0 16800975 0 0 0 -1 0 0 0 28 0 0
[pid=24337/tid=24339] ppid=24334 vsize=1047276 CPUtime=9.43
/proc/24337/task/24339/stat : 24339 (java) S 24334 24334 32685 0 -1 4202560 95183 0 0 0 915 28 0 0 20 0 11 0 41574396 1072410624 157996 18446744073709551615 4194304 4228012 140735982201200 140196563160192 140196664002123 0 0 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24340] ppid=24334 vsize=1047276 CPUtime=0
/proc/24337/task/24340/stat : 24340 (java) S 24334 24334 32685 0 -1 4202560 16 0 0 0 0 0 0 0 20 0 11 0 41574396 1072410624 157996 18446744073709551615 4194304 4228012 140735982201200 140196562106384 140196664001236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24341] ppid=24334 vsize=1047276 CPUtime=0
/proc/24337/task/24341/stat : 24341 (java) S 24334 24334 32685 0 -1 4202560 9 0 0 0 0 0 0 0 20 0 11 0 41574396 1072410624 157996 18446744073709551615 4194304 4228012 140735982201200 140196561053600 140196664001236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24342] ppid=24334 vsize=1047276 CPUtime=0
/proc/24337/task/24342/stat : 24342 (java) S 24334 24334 32685 0 -1 4202560 1 0 0 0 0 0 0 0 20 0 11 0 41574399 1072410624 157996 18446744073709551615 4194304 4228012 140735982201200 140196560002032 140196664009760 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24343] ppid=24334 vsize=1047276 CPUtime=2.5
/proc/24337/task/24343/stat : 24343 (java) S 24334 24334 32685 0 -1 4202560 9854 0 0 0 248 2 0 0 20 0 11 0 41574399 1072410624 157996 18446744073709551615 4194304 4228012 140735982201200 140196558949392 140196664001236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24344] ppid=24334 vsize=1047276 CPUtime=2.6
/proc/24337/task/24344/stat : 24344 (java) S 24334 24334 32685 0 -1 4202560 10243 0 0 0 256 4 0 0 20 0 11 0 41574399 1072410624 157996 18446744073709551615 4194304 4228012 140735982201200 140196557896720 140196664001236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24345] ppid=24334 vsize=1047276 CPUtime=0
/proc/24337/task/24345/stat : 24345 (java) S 24334 24334 32685 0 -1 4202560 0 0 0 0 0 0 0 0 20 0 11 0 41574399 1072410624 157996 18446744073709551615 4194304 4228012 140735982201200 140196556844240 140196664001236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24346] ppid=24334 vsize=1047276 CPUtime=0.08
/proc/24337/task/24346/stat : 24346 (java) S 24334 24334 32685 0 -1 4202560 16 0 0 0 0 8 0 0 20 0 11 0 41574399 1072410624 157996 18446744073709551615 4194304 4228012 140735982201200 140196555791744 140196664002123 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24347] ppid=24334 vsize=1047276 CPUtime=0
/proc/24337/task/24347/stat : 24347 (java) S 24334 24334 32685 0 -1 4202560 6 0 0 0 0 0 0 0 20 0 11 0 41575688 1072410624 157996 18446744073709551615 4194304 4228012 140735982201200 140196554590048 140196664002123 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
Current children cumulated CPU time (s) 151.52
Current children cumulated vsize (KiB) 1056444

[startup+222.303 s]
/proc/loadavg: 1.06 1.05 1.00 2/68 24801
/proc/meminfo: memFree=10120/1022884 swapFree=0/0
[pid=24334] ppid=24333 vsize=9168 CPUtime=0
/proc/24334/stat : 24334 (p2cudf-full-1.1) S 24333 24334 32685 0 -1 4202496 457 292 0 0 0 0 0 0 20 0 1 0 41574393 9388032 331 18446744073709551615 4194304 5129932 140734090799488 140734090797632 139818967401566 0 65536 16781316 65538 0 0 0 17 0 0 0 0 0 0
/proc/24334/statm: 2292 331 280 229 0 52 0
[pid=24337] ppid=24334 vsize=1047276 CPUtime=211.01
/proc/24337/stat : 24337 (java) S 24334 24334 32685 0 -1 4202496 165950 0 0 0 21041 60 0 0 20 0 11 0 41574393 1072410624 159549 18446744073709551615 4194304 4228012 140735982201200 140735982192224 140196663987829 0 0 0 16800975 18446744073709551615 0 0 17 0 0 0 0 0 0
/proc/24337/statm: 261819 159549 2379 9 0 249169 0
[pid=24337/tid=24338] ppid=24334 vsize=1047276 CPUtime=194.68
/proc/24337/task/24338/stat : 24338 (java) R 24334 24334 32685 0 -1 4202560 47799 0 0 0 19444 24 0 0 20 0 11 0 41574394 1072410624 159549 18446744073709551615 4194304 4228012 140735982201200 140196670521416 140196568972790 0 4 0 16800975 0 0 0 -1 0 0 0 28 0 0
[pid=24337/tid=24339] ppid=24334 vsize=1047276 CPUtime=11.08
/proc/24337/task/24339/stat : 24339 (java) S 24334 24334 32685 0 -1 4202560 96738 0 0 0 1080 28 0 0 20 0 11 0 41574396 1072410624 159549 18446744073709551615 4194304 4228012 140735982201200 140196563160192 140196664002123 0 0 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24340] ppid=24334 vsize=1047276 CPUtime=0
/proc/24337/task/24340/stat : 24340 (java) S 24334 24334 32685 0 -1 4202560 16 0 0 0 0 0 0 0 20 0 11 0 41574396 1072410624 159549 18446744073709551615 4194304 4228012 140735982201200 140196562106384 140196664001236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24341] ppid=24334 vsize=1047276 CPUtime=0
/proc/24337/task/24341/stat : 24341 (java) S 24334 24334 32685 0 -1 4202560 9 0 0 0 0 0 0 0 20 0 11 0 41574396 1072410624 159549 18446744073709551615 4194304 4228012 140735982201200 140196561053600 140196664001236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24342] ppid=24334 vsize=1047276 CPUtime=0
/proc/24337/task/24342/stat : 24342 (java) S 24334 24334 32685 0 -1 4202560 1 0 0 0 0 0 0 0 20 0 11 0 41574399 1072410624 159549 18446744073709551615 4194304 4228012 140735982201200 140196560002032 140196664009760 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24343] ppid=24334 vsize=1047276 CPUtime=2.5
/proc/24337/task/24343/stat : 24343 (java) S 24334 24334 32685 0 -1 4202560 9854 0 0 0 248 2 0 0 20 0 11 0 41574399 1072410624 159549 18446744073709551615 4194304 4228012 140735982201200 140196558949392 140196664001236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24344] ppid=24334 vsize=1047276 CPUtime=2.6
/proc/24337/task/24344/stat : 24344 (java) S 24334 24334 32685 0 -1 4202560 10243 0 0 0 256 4 0 0 20 0 11 0 41574399 1072410624 159549 18446744073709551615 4194304 4228012 140735982201200 140196557896720 140196664001236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24345] ppid=24334 vsize=1047276 CPUtime=0
/proc/24337/task/24345/stat : 24345 (java) S 24334 24334 32685 0 -1 4202560 0 0 0 0 0 0 0 0 20 0 11 0 41574399 1072410624 159549 18446744073709551615 4194304 4228012 140735982201200 140196556844240 140196664001236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24346] ppid=24334 vsize=1047276 CPUtime=0.11
/proc/24337/task/24346/stat : 24346 (java) S 24334 24334 32685 0 -1 4202560 19 0 0 0 0 11 0 0 20 0 11 0 41574399 1072410624 159549 18446744073709551615 4194304 4228012 140735982201200 140196555791744 140196664002123 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24347] ppid=24334 vsize=1047276 CPUtime=0
/proc/24337/task/24347/stat : 24347 (java) S 24334 24334 32685 0 -1 4202560 6 0 0 0 0 0 0 0 20 0 11 0 41575688 1072410624 159549 18446744073709551615 4194304 4228012 140735982201200 140196554590048 140196664002123 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
Current children cumulated CPU time (s) 211.01
Current children cumulated vsize (KiB) 1056444

[startup+282.301 s]
/proc/loadavg: 1.02 1.04 1.00 2/68 24801
/proc/meminfo: memFree=9500/1022884 swapFree=0/0
[pid=24334] ppid=24333 vsize=9168 CPUtime=0
/proc/24334/stat : 24334 (p2cudf-full-1.1) S 24333 24334 32685 0 -1 4202496 457 292 0 0 0 0 0 0 20 0 1 0 41574393 9388032 331 18446744073709551615 4194304 5129932 140734090799488 140734090797632 139818967401566 0 65536 16781316 65538 0 0 0 17 0 0 0 0 0 0
/proc/24334/statm: 2292 331 280 229 0 52 0
[pid=24337] ppid=24334 vsize=1047276 CPUtime=270.51
/proc/24337/stat : 24337 (java) S 24334 24334 32685 0 -1 4202496 166919 0 0 0 26990 61 0 0 20 0 11 0 41574393 1072410624 160510 18446744073709551615 4194304 4228012 140735982201200 140735982192224 140196663987829 0 0 0 16800975 18446744073709551615 0 0 17 0 0 0 0 0 0
/proc/24337/statm: 261819 160510 2379 9 0 249169 0
[pid=24337/tid=24338] ppid=24334 vsize=1047276 CPUtime=251.63
/proc/24337/task/24338/stat : 24338 (java) R 24334 24334 32685 0 -1 4202560 47799 0 0 0 25138 25 0 0 20 0 11 0 41574394 1072410624 160510 18446744073709551615 4194304 4228012 140735982201200 140196670521416 140196568977618 0 4 0 16800975 0 0 0 -1 0 0 0 28 0 0
[pid=24337/tid=24339] ppid=24334 vsize=1047276 CPUtime=13.59
/proc/24337/task/24339/stat : 24339 (java) S 24334 24334 32685 0 -1 4202560 97701 0 0 0 1330 29 0 0 20 0 11 0 41574396 1072410624 160510 18446744073709551615 4194304 4228012 140735982201200 140196563160192 140196664002123 0 0 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24340] ppid=24334 vsize=1047276 CPUtime=0
/proc/24337/task/24340/stat : 24340 (java) S 24334 24334 32685 0 -1 4202560 16 0 0 0 0 0 0 0 20 0 11 0 41574396 1072410624 160510 18446744073709551615 4194304 4228012 140735982201200 140196562106384 140196664001236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24341] ppid=24334 vsize=1047276 CPUtime=0
/proc/24337/task/24341/stat : 24341 (java) S 24334 24334 32685 0 -1 4202560 9 0 0 0 0 0 0 0 20 0 11 0 41574396 1072410624 160510 18446744073709551615 4194304 4228012 140735982201200 140196561053600 140196664001236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24342] ppid=24334 vsize=1047276 CPUtime=0
/proc/24337/task/24342/stat : 24342 (java) S 24334 24334 32685 0 -1 4202560 1 0 0 0 0 0 0 0 20 0 11 0 41574399 1072410624 160510 18446744073709551615 4194304 4228012 140735982201200 140196560002032 140196664009760 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24343] ppid=24334 vsize=1047276 CPUtime=2.5
/proc/24337/task/24343/stat : 24343 (java) S 24334 24334 32685 0 -1 4202560 9854 0 0 0 248 2 0 0 20 0 11 0 41574399 1072410624 160510 18446744073709551615 4194304 4228012 140735982201200 140196558949392 140196664001236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24344] ppid=24334 vsize=1047276 CPUtime=2.62
/proc/24337/task/24344/stat : 24344 (java) S 24334 24334 32685 0 -1 4202560 10243 0 0 0 258 4 0 0 20 0 11 0 41574399 1072410624 160510 18446744073709551615 4194304 4228012 140735982201200 140196557896720 140196664001236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24345] ppid=24334 vsize=1047276 CPUtime=0
/proc/24337/task/24345/stat : 24345 (java) S 24334 24334 32685 0 -1 4202560 0 0 0 0 0 0 0 0 20 0 11 0 41574399 1072410624 160510 18446744073709551615 4194304 4228012 140735982201200 140196556844240 140196664001236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24346] ppid=24334 vsize=1047276 CPUtime=0.14
/proc/24337/task/24346/stat : 24346 (java) S 24334 24334 32685 0 -1 4202560 25 0 0 0 0 14 0 0 20 0 11 0 41574399 1072410624 160510 18446744073709551615 4194304 4228012 140735982201200 140196555791744 140196664002123 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24347] ppid=24334 vsize=1047276 CPUtime=0
/proc/24337/task/24347/stat : 24347 (java) S 24334 24334 32685 0 -1 4202560 6 0 0 0 0 0 0 0 20 0 11 0 41575688 1072410624 160510 18446744073709551615 4194304 4228012 140735982201200 140196554590048 140196664002123 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
Current children cumulated CPU time (s) 270.51
Current children cumulated vsize (KiB) 1056444

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

[startup+288.001 s]
/proc/loadavg: 1.02 1.04 1.00 2/68 24801
/proc/meminfo: memFree=9500/1022884 swapFree=0/0
[pid=24334] ppid=24333 vsize=9168 CPUtime=0
/proc/24334/stat : 24334 (p2cudf-full-1.1) S 24333 24334 32685 0 -1 4202496 457 292 0 0 0 0 0 0 20 0 1 0 41574393 9388032 331 18446744073709551615 4194304 5129932 140734090799488 140734090797632 139818967401566 0 65536 16781316 65538 0 0 0 17 0 0 0 0 0 0
/proc/24334/statm: 2292 331 280 229 0 52 0
[pid=24337] ppid=24334 vsize=1047276 CPUtime=276.16
/proc/24337/stat : 24337 (java) S 24334 24334 32685 0 -1 4202496 166919 0 0 0 27555 61 0 0 20 0 11 0 41574393 1072410624 160510 18446744073709551615 4194304 4228012 140735982201200 140735982192224 140196663987829 0 0 0 16800975 18446744073709551615 0 0 17 0 0 0 0 0 0
/proc/24337/statm: 261819 160510 2379 9 0 249169 0
[pid=24337/tid=24338] ppid=24334 vsize=1047276 CPUtime=257.28
/proc/24337/task/24338/stat : 24338 (java) R 24334 24334 32685 0 -1 4202560 47799 0 0 0 25703 25 0 0 20 0 11 0 41574394 1072410624 160510 18446744073709551615 4194304 4228012 140735982201200 140196670521416 140196569368079 0 4 0 16800975 0 0 0 -1 0 0 0 28 0 0
[pid=24337/tid=24339] ppid=24334 vsize=1047276 CPUtime=13.59
/proc/24337/task/24339/stat : 24339 (java) S 24334 24334 32685 0 -1 4202560 97701 0 0 0 1330 29 0 0 20 0 11 0 41574396 1072410624 160510 18446744073709551615 4194304 4228012 140735982201200 140196563160192 140196664002123 0 0 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24340] ppid=24334 vsize=1047276 CPUtime=0
/proc/24337/task/24340/stat : 24340 (java) S 24334 24334 32685 0 -1 4202560 16 0 0 0 0 0 0 0 20 0 11 0 41574396 1072410624 160510 18446744073709551615 4194304 4228012 140735982201200 140196562106384 140196664001236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24341] ppid=24334 vsize=1047276 CPUtime=0
/proc/24337/task/24341/stat : 24341 (java) S 24334 24334 32685 0 -1 4202560 9 0 0 0 0 0 0 0 20 0 11 0 41574396 1072410624 160510 18446744073709551615 4194304 4228012 140735982201200 140196561053600 140196664001236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24342] ppid=24334 vsize=1047276 CPUtime=0
/proc/24337/task/24342/stat : 24342 (java) S 24334 24334 32685 0 -1 4202560 1 0 0 0 0 0 0 0 20 0 11 0 41574399 1072410624 160510 18446744073709551615 4194304 4228012 140735982201200 140196560002032 140196664009760 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24343] ppid=24334 vsize=1047276 CPUtime=2.5
/proc/24337/task/24343/stat : 24343 (java) S 24334 24334 32685 0 -1 4202560 9854 0 0 0 248 2 0 0 20 0 11 0 41574399 1072410624 160510 18446744073709551615 4194304 4228012 140735982201200 140196558949392 140196664001236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24344] ppid=24334 vsize=1047276 CPUtime=2.62
/proc/24337/task/24344/stat : 24344 (java) S 24334 24334 32685 0 -1 4202560 10243 0 0 0 258 4 0 0 20 0 11 0 41574399 1072410624 160510 18446744073709551615 4194304 4228012 140735982201200 140196557896720 140196664001236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24345] ppid=24334 vsize=1047276 CPUtime=0
/proc/24337/task/24345/stat : 24345 (java) S 24334 24334 32685 0 -1 4202560 0 0 0 0 0 0 0 0 20 0 11 0 41574399 1072410624 160510 18446744073709551615 4194304 4228012 140735982201200 140196556844240 140196664001236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24346] ppid=24334 vsize=1047276 CPUtime=0.14
/proc/24337/task/24346/stat : 24346 (java) S 24334 24334 32685 0 -1 4202560 25 0 0 0 0 14 0 0 20 0 11 0 41574399 1072410624 160510 18446744073709551615 4194304 4228012 140735982201200 140196555791744 140196664002123 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24347] ppid=24334 vsize=1047276 CPUtime=0
/proc/24337/task/24347/stat : 24347 (java) S 24334 24334 32685 0 -1 4202560 6 0 0 0 0 0 0 0 20 0 11 0 41575688 1072410624 160510 18446744073709551615 4194304 4228012 140735982201200 140196554590048 140196664002123 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
Current children cumulated CPU time (s) 276.16
Current children cumulated vsize (KiB) 1056444

[startup+294.401 s]
/proc/loadavg: 1.01 1.03 1.00 2/68 24801
/proc/meminfo: memFree=9500/1022884 swapFree=0/0
[pid=24334] ppid=24333 vsize=9168 CPUtime=0
/proc/24334/stat : 24334 (p2cudf-full-1.1) S 24333 24334 32685 0 -1 4202496 457 292 0 0 0 0 0 0 20 0 1 0 41574393 9388032 331 18446744073709551615 4194304 5129932 140734090799488 140734090797632 139818967401566 0 65536 16781316 65538 0 0 0 17 0 0 0 0 0 0
/proc/24334/statm: 2292 331 280 229 0 52 0
[pid=24337] ppid=24334 vsize=1047276 CPUtime=282.51
/proc/24337/stat : 24337 (java) S 24334 24334 32685 0 -1 4202496 166922 0 0 0 28190 61 0 0 20 0 11 0 41574393 1072410624 160510 18446744073709551615 4194304 4228012 140735982201200 140735982192224 140196663987829 0 0 0 16800975 18446744073709551615 0 0 17 0 0 0 0 0 0
/proc/24337/statm: 261819 160510 2379 9 0 249169 0
[pid=24337/tid=24338] ppid=24334 vsize=1047276 CPUtime=262.81
/proc/24337/task/24338/stat : 24338 (java) R 24334 24334 32685 0 -1 4202560 47799 0 0 0 26256 25 0 0 20 0 11 0 41574394 1072410624 160510 18446744073709551615 4194304 4228012 140735982201200 140196670521416 140196568310001 0 4 0 16800975 0 0 0 -1 0 0 0 28 0 0
[pid=24337/tid=24339] ppid=24334 vsize=1047276 CPUtime=14.4
/proc/24337/task/24339/stat : 24339 (java) S 24334 24334 32685 0 -1 4202560 97701 0 0 0 1411 29 0 0 20 0 11 0 41574396 1072410624 160510 18446744073709551615 4194304 4228012 140735982201200 140196563160192 140196664002123 0 0 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24340] ppid=24334 vsize=1047276 CPUtime=0
/proc/24337/task/24340/stat : 24340 (java) S 24334 24334 32685 0 -1 4202560 16 0 0 0 0 0 0 0 20 0 11 0 41574396 1072410624 160510 18446744073709551615 4194304 4228012 140735982201200 140196562106384 140196664001236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24341] ppid=24334 vsize=1047276 CPUtime=0
/proc/24337/task/24341/stat : 24341 (java) S 24334 24334 32685 0 -1 4202560 9 0 0 0 0 0 0 0 20 0 11 0 41574396 1072410624 160510 18446744073709551615 4194304 4228012 140735982201200 140196561053600 140196664001236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24342] ppid=24334 vsize=1047276 CPUtime=0
/proc/24337/task/24342/stat : 24342 (java) S 24334 24334 32685 0 -1 4202560 1 0 0 0 0 0 0 0 20 0 11 0 41574399 1072410624 160510 18446744073709551615 4194304 4228012 140735982201200 140196560002032 140196664009760 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24343] ppid=24334 vsize=1047276 CPUtime=2.5
/proc/24337/task/24343/stat : 24343 (java) S 24334 24334 32685 0 -1 4202560 9854 0 0 0 248 2 0 0 20 0 11 0 41574399 1072410624 160510 18446744073709551615 4194304 4228012 140735982201200 140196558949392 140196664001236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24344] ppid=24334 vsize=1047276 CPUtime=2.62
/proc/24337/task/24344/stat : 24344 (java) S 24334 24334 32685 0 -1 4202560 10243 0 0 0 258 4 0 0 20 0 11 0 41574399 1072410624 160510 18446744073709551615 4194304 4228012 140735982201200 140196557896720 140196664001236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24345] ppid=24334 vsize=1047276 CPUtime=0
/proc/24337/task/24345/stat : 24345 (java) S 24334 24334 32685 0 -1 4202560 0 0 0 0 0 0 0 0 20 0 11 0 41574399 1072410624 160510 18446744073709551615 4194304 4228012 140735982201200 140196556844240 140196664001236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24346] ppid=24334 vsize=1047276 CPUtime=0.15
/proc/24337/task/24346/stat : 24346 (java) S 24334 24334 32685 0 -1 4202560 28 0 0 0 0 15 0 0 20 0 11 0 41574399 1072410624 160510 18446744073709551615 4194304 4228012 140735982201200 140196555791744 140196664002123 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24347] ppid=24334 vsize=1047276 CPUtime=0
/proc/24337/task/24347/stat : 24347 (java) S 24334 24334 32685 0 -1 4202560 6 0 0 0 0 0 0 0 20 0 11 0 41575688 1072410624 160510 18446744073709551615 4194304 4228012 140735982201200 140196554590048 140196664002123 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
Current children cumulated CPU time (s) 282.51
Current children cumulated vsize (KiB) 1056444

[startup+296.004 s]
/proc/loadavg: 1.01 1.03 1.00 2/68 24801
/proc/meminfo: memFree=9500/1022884 swapFree=0/0
[pid=24334] ppid=24333 vsize=9168 CPUtime=0
/proc/24334/stat : 24334 (p2cudf-full-1.1) S 24333 24334 32685 0 -1 4202496 457 292 0 0 0 0 0 0 20 0 1 0 41574393 9388032 331 18446744073709551615 4194304 5129932 140734090799488 140734090797632 139818967401566 0 65536 16781316 65538 0 0 0 17 0 0 0 0 0 0
/proc/24334/statm: 2292 331 280 229 0 52 0
[pid=24337] ppid=24334 vsize=1047276 CPUtime=284.09
/proc/24337/stat : 24337 (java) S 24334 24334 32685 0 -1 4202496 166922 0 0 0 28348 61 0 0 20 0 11 0 41574393 1072410624 160510 18446744073709551615 4194304 4228012 140735982201200 140735982192224 140196663987829 0 0 0 16800975 18446744073709551615 0 0 17 0 0 0 0 0 0
/proc/24337/statm: 261819 160510 2379 9 0 249169 0
[pid=24337/tid=24338] ppid=24334 vsize=1047276 CPUtime=264.4
/proc/24337/task/24338/stat : 24338 (java) R 24334 24334 32685 0 -1 4202560 47799 0 0 0 26415 25 0 0 20 0 11 0 41574394 1072410624 160510 18446744073709551615 4194304 4228012 140735982201200 140196670521416 140196568983584 0 4 0 16800975 0 0 0 -1 0 0 0 28 0 0
[pid=24337/tid=24339] ppid=24334 vsize=1047276 CPUtime=14.4
/proc/24337/task/24339/stat : 24339 (java) S 24334 24334 32685 0 -1 4202560 97701 0 0 0 1411 29 0 0 20 0 11 0 41574396 1072410624 160510 18446744073709551615 4194304 4228012 140735982201200 140196563160192 140196664002123 0 0 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24340] ppid=24334 vsize=1047276 CPUtime=0
/proc/24337/task/24340/stat : 24340 (java) S 24334 24334 32685 0 -1 4202560 16 0 0 0 0 0 0 0 20 0 11 0 41574396 1072410624 160510 18446744073709551615 4194304 4228012 140735982201200 140196562106384 140196664001236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24341] ppid=24334 vsize=1047276 CPUtime=0
/proc/24337/task/24341/stat : 24341 (java) S 24334 24334 32685 0 -1 4202560 9 0 0 0 0 0 0 0 20 0 11 0 41574396 1072410624 160510 18446744073709551615 4194304 4228012 140735982201200 140196561053600 140196664001236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24342] ppid=24334 vsize=1047276 CPUtime=0
/proc/24337/task/24342/stat : 24342 (java) S 24334 24334 32685 0 -1 4202560 1 0 0 0 0 0 0 0 20 0 11 0 41574399 1072410624 160510 18446744073709551615 4194304 4228012 140735982201200 140196560002032 140196664009760 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24343] ppid=24334 vsize=1047276 CPUtime=2.5
/proc/24337/task/24343/stat : 24343 (java) S 24334 24334 32685 0 -1 4202560 9854 0 0 0 248 2 0 0 20 0 11 0 41574399 1072410624 160510 18446744073709551615 4194304 4228012 140735982201200 140196558949392 140196664001236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24344] ppid=24334 vsize=1047276 CPUtime=2.62
/proc/24337/task/24344/stat : 24344 (java) S 24334 24334 32685 0 -1 4202560 10243 0 0 0 258 4 0 0 20 0 11 0 41574399 1072410624 160510 18446744073709551615 4194304 4228012 140735982201200 140196557896720 140196664001236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24345] ppid=24334 vsize=1047276 CPUtime=0
/proc/24337/task/24345/stat : 24345 (java) S 24334 24334 32685 0 -1 4202560 0 0 0 0 0 0 0 0 20 0 11 0 41574399 1072410624 160510 18446744073709551615 4194304 4228012 140735982201200 140196556844240 140196664001236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24346] ppid=24334 vsize=1047276 CPUtime=0.15
/proc/24337/task/24346/stat : 24346 (java) S 24334 24334 32685 0 -1 4202560 28 0 0 0 0 15 0 0 20 0 11 0 41574399 1072410624 160510 18446744073709551615 4194304 4228012 140735982201200 140196555791744 140196664002123 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24347] ppid=24334 vsize=1047276 CPUtime=0
/proc/24337/task/24347/stat : 24347 (java) S 24334 24334 32685 0 -1 4202560 6 0 0 0 0 0 0 0 20 0 11 0 41575688 1072410624 160510 18446744073709551615 4194304 4228012 140735982201200 140196554590048 140196664002123 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
Current children cumulated CPU time (s) 284.09
Current children cumulated vsize (KiB) 1056444

[startup+297.601 s]
/proc/loadavg: 1.01 1.03 1.00 2/68 24801
/proc/meminfo: memFree=9500/1022884 swapFree=0/0
[pid=24334] ppid=24333 vsize=9168 CPUtime=0
/proc/24334/stat : 24334 (p2cudf-full-1.1) S 24333 24334 32685 0 -1 4202496 457 292 0 0 0 0 0 0 20 0 1 0 41574393 9388032 331 18446744073709551615 4194304 5129932 140734090799488 140734090797632 139818967401566 0 65536 16781316 65538 0 0 0 17 0 0 0 0 0 0
/proc/24334/statm: 2292 331 280 229 0 52 0
[pid=24337] ppid=24334 vsize=1047276 CPUtime=285.68
/proc/24337/stat : 24337 (java) S 24334 24334 32685 0 -1 4202496 166922 0 0 0 28507 61 0 0 20 0 11 0 41574393 1072410624 160510 18446744073709551615 4194304 4228012 140735982201200 140735982192224 140196663987829 0 0 0 16800975 18446744073709551615 0 0 17 0 0 0 0 0 0
/proc/24337/statm: 261819 160510 2379 9 0 249169 0
[pid=24337/tid=24338] ppid=24334 vsize=1047276 CPUtime=265.98
/proc/24337/task/24338/stat : 24338 (java) R 24334 24334 32685 0 -1 4202560 47799 0 0 0 26573 25 0 0 20 0 11 0 41574394 1072410624 160510 18446744073709551615 4194304 4228012 140735982201200 140196670521416 140196568972385 0 4 0 16800975 0 0 0 -1 0 0 0 28 0 0
[pid=24337/tid=24339] ppid=24334 vsize=1047276 CPUtime=14.4
/proc/24337/task/24339/stat : 24339 (java) S 24334 24334 32685 0 -1 4202560 97701 0 0 0 1411 29 0 0 20 0 11 0 41574396 1072410624 160510 18446744073709551615 4194304 4228012 140735982201200 140196563160192 140196664002123 0 0 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24340] ppid=24334 vsize=1047276 CPUtime=0
/proc/24337/task/24340/stat : 24340 (java) S 24334 24334 32685 0 -1 4202560 16 0 0 0 0 0 0 0 20 0 11 0 41574396 1072410624 160510 18446744073709551615 4194304 4228012 140735982201200 140196562106384 140196664001236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24341] ppid=24334 vsize=1047276 CPUtime=0
/proc/24337/task/24341/stat : 24341 (java) S 24334 24334 32685 0 -1 4202560 9 0 0 0 0 0 0 0 20 0 11 0 41574396 1072410624 160510 18446744073709551615 4194304 4228012 140735982201200 140196561053600 140196664001236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24342] ppid=24334 vsize=1047276 CPUtime=0
/proc/24337/task/24342/stat : 24342 (java) S 24334 24334 32685 0 -1 4202560 1 0 0 0 0 0 0 0 20 0 11 0 41574399 1072410624 160510 18446744073709551615 4194304 4228012 140735982201200 140196560002032 140196664009760 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24343] ppid=24334 vsize=1047276 CPUtime=2.5
/proc/24337/task/24343/stat : 24343 (java) S 24334 24334 32685 0 -1 4202560 9854 0 0 0 248 2 0 0 20 0 11 0 41574399 1072410624 160510 18446744073709551615 4194304 4228012 140735982201200 140196558949392 140196664001236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24344] ppid=24334 vsize=1047276 CPUtime=2.62
/proc/24337/task/24344/stat : 24344 (java) S 24334 24334 32685 0 -1 4202560 10243 0 0 0 258 4 0 0 20 0 11 0 41574399 1072410624 160510 18446744073709551615 4194304 4228012 140735982201200 140196557896720 140196664001236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24345] ppid=24334 vsize=1047276 CPUtime=0
/proc/24337/task/24345/stat : 24345 (java) S 24334 24334 32685 0 -1 4202560 0 0 0 0 0 0 0 0 20 0 11 0 41574399 1072410624 160510 18446744073709551615 4194304 4228012 140735982201200 140196556844240 140196664001236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24346] ppid=24334 vsize=1047276 CPUtime=0.15
/proc/24337/task/24346/stat : 24346 (java) S 24334 24334 32685 0 -1 4202560 28 0 0 0 0 15 0 0 20 0 11 0 41574399 1072410624 160510 18446744073709551615 4194304 4228012 140735982201200 140196555791744 140196664002123 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24347] ppid=24334 vsize=1047276 CPUtime=0
/proc/24337/task/24347/stat : 24347 (java) S 24334 24334 32685 0 -1 4202560 6 0 0 0 0 0 0 0 20 0 11 0 41575688 1072410624 160510 18446744073709551615 4194304 4228012 140735982201200 140196554590048 140196664002123 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
Current children cumulated CPU time (s) 285.68
Current children cumulated vsize (KiB) 1056444

[startup+298.401 s]
/proc/loadavg: 1.01 1.03 1.00 1/68 24802
/proc/meminfo: memFree=9500/1022884 swapFree=0/0
[pid=24334] ppid=24333 vsize=9168 CPUtime=0
/proc/24334/stat : 24334 (p2cudf-full-1.1) S 24333 24334 32685 0 -1 4202496 457 292 0 0 0 0 0 0 20 0 1 0 41574393 9388032 331 18446744073709551615 4194304 5129932 140734090799488 140734090797632 139818967401566 0 65536 16781316 65538 0 0 0 17 0 0 0 0 0 0
/proc/24334/statm: 2292 331 280 229 0 52 0
[pid=24337] ppid=24334 vsize=1048304 CPUtime=286.07
/proc/24337/stat : 24337 (java) S 24334 24334 32685 0 -1 4202496 166938 0 0 0 28546 61 0 0 20 0 11 0 41574393 1073463296 160523 18446744073709551615 4194304 4228012 140735982201200 140735982192224 140196663987829 0 0 0 16800975 18446744073709551615 0 0 17 0 0 0 0 0 0
/proc/24337/statm: 262076 160523 2379 9 0 249426 0
[pid=24337/tid=24338] ppid=24334 vsize=1048304 CPUtime=266.36
/proc/24337/task/24338/stat : 24338 (java) S 24334 24334 32685 0 -1 4202560 47809 0 0 0 26611 25 0 0 20 0 11 0 41574394 1073463296 160523 18446744073709551615 4194304 4228012 140735982201200 140196670522288 140196664001236 0 4 0 16800975 0 0 0 -1 0 0 0 33 0 0
[pid=24337/tid=24339] ppid=24334 vsize=1048304 CPUtime=14.4
/proc/24337/task/24339/stat : 24339 (java) S 24334 24334 32685 0 -1 4202560 97701 0 0 0 1411 29 0 0 20 0 11 0 41574396 1073463296 160523 18446744073709551615 4194304 4228012 140735982201200 140196563160192 140196664002123 0 0 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24340] ppid=24334 vsize=1048304 CPUtime=0
/proc/24337/task/24340/stat : 24340 (java) S 24334 24334 32685 0 -1 4202560 16 0 0 0 0 0 0 0 20 0 11 0 41574396 1073463296 160523 18446744073709551615 4194304 4228012 140735982201200 140196562106384 140196664001236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24341] ppid=24334 vsize=1048304 CPUtime=0
/proc/24337/task/24341/stat : 24341 (java) S 24334 24334 32685 0 -1 4202560 9 0 0 0 0 0 0 0 20 0 11 0 41574396 1073463296 160523 18446744073709551615 4194304 4228012 140735982201200 140196561053600 140196664001236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24342] ppid=24334 vsize=1048304 CPUtime=0
/proc/24337/task/24342/stat : 24342 (java) S 24334 24334 32685 0 -1 4202560 1 0 0 0 0 0 0 0 20 0 11 0 41574399 1073463296 160523 18446744073709551615 4194304 4228012 140735982201200 140196560002032 140196664009760 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24343] ppid=24334 vsize=1048304 CPUtime=2.5
/proc/24337/task/24343/stat : 24343 (java) S 24334 24334 32685 0 -1 4202560 9854 0 0 0 248 2 0 0 20 0 11 0 41574399 1073463296 160523 18446744073709551615 4194304 4228012 140735982201200 140196558949392 140196664001236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24344] ppid=24334 vsize=1048304 CPUtime=2.63
/proc/24337/task/24344/stat : 24344 (java) S 24334 24334 32685 0 -1 4202560 10243 0 0 0 259 4 0 0 20 0 11 0 41574399 1073463296 160523 18446744073709551615 4194304 4228012 140735982201200 140196557896720 140196664001236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24345] ppid=24334 vsize=1048304 CPUtime=0
/proc/24337/task/24345/stat : 24345 (java) S 24334 24334 32685 0 -1 4202560 0 0 0 0 0 0 0 0 20 0 11 0 41574399 1073463296 160523 18446744073709551615 4194304 4228012 140735982201200 140196556844240 140196664001236 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24346] ppid=24334 vsize=1048304 CPUtime=0.15
/proc/24337/task/24346/stat : 24346 (java) S 24334 24334 32685 0 -1 4202560 28 0 0 0 0 15 0 0 20 0 11 0 41574399 1073463296 160523 18446744073709551615 4194304 4228012 140735982201200 140196555791744 140196664002123 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=24337/tid=24802] ppid=24334 vsize=1048304 CPUtime=0
/proc/24337/task/24802/stat : 24802 (java) S 24334 24334 32685 0 -1 4202560 6 0 0 0 0 0 0 0 20 0 11 0 41604197 1073463296 160523 18446744073709551615 4194304 4228012 140735982201200 140196553537712 140196664002123 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
Current children cumulated CPU time (s) 286.07
Current children cumulated vsize (KiB) 1057472

[startup+298.801 s]
/proc/loadavg: 1.01 1.03 1.00 1/68 24802
/proc/meminfo: memFree=9500/1022884 swapFree=0/0
[pid=24334] ppid=24333 vsize=9168 CPUtime=286.28
/proc/24334/stat : 24334 (p2cudf-full-1.1) D 24333 24334 32685 0 -1 4202496 461 167243 0 0 0 0 28556 72 20 0 1 0 41574393 9388032 331 18446744073709551615 4194304 5129932 140734090799488 140734090794696 139818967545632 0 0 16781316 65536 0 0 0 17 0 0 0 0 0 0
/proc/24334/statm: 2292 331 280 229 0 52 0
Current children cumulated CPU time (s) 286.28
Current children cumulated vsize (KiB) 9168

Child status: 0
Real time (s): 298.805
CPU time (s): 286.29
CPU user time (s): 285.566
CPU system time (s): 0.724045
CPU usage (%): 95.8115
Max. virtual memory (cumulated for all children) (KiB): 1060392

getrusage(RUSAGE_CHILDREN,...) data:
user time used= 285.566
system time used= 0.724045
maximum resident set size= 642128
integral shared memory size= 0
integral unshared data size= 0
integral unshared stack size= 0
page reclaims= 167713
page faults= 0
swaps= 0
block input operations= 68520
block output operations= 584
messages sent= 0
messages received= 0
signals received= 0
voluntary context switches= 7361
involuntary context switches= 18780

runsolver used 1.06407 second user time and 1.5601 second system time

The end