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/slowlink/upgrade/difficult/rand484.cudf.log.runsolver /home/competition/p2cudf-full-1.15/p2cudf-full-1.15 /home/competition/data/upgrade/difficult/rand484.cudf /tmp/misc2012/2012-09-02-22:42/full/p2cudf-full-1.15/slowlink/upgrade/difficult/rand484.cudf.result -sum(changed,installedsize),-count(removed),-notuptodate(solution),-count(changed) 

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.01 1.04 1.03 2/60 29135
/proc/meminfo: memFree=690628/1022884 swapFree=0/0
[pid=29135] ppid=29134 vsize=1068 CPUtime=0
/proc/29135/stat : 29135 (p2cudf-full-1.1) D 29134 29135 32685 0 -1 4194304 75 0 0 0 0 0 0 0 20 0 1 0 42838304 1093632 1 18446744073709551615 0 0 140737433172918 4292226208 4151940144 0 0 16781316 0 0 0 0 17 0 0 0 0 0 0
/proc/29135/statm: 267 1 0 0 0 28 0

[startup+0.122497 s]
/proc/loadavg: 1.01 1.04 1.03 2/60 29135
/proc/meminfo: memFree=690628/1022884 swapFree=0/0
[pid=29135] ppid=29134 vsize=9168 CPUtime=0
/proc/29135/stat : 29135 (p2cudf-full-1.1) S 29134 29135 32685 0 -1 4202496 454 290 2 1 0 0 0 0 20 0 1 0 42838304 9388032 331 18446744073709551615 4194304 5129932 140737433165920 140737433164064 139788051719262 0 65536 16781316 65538 0 0 0 17 0 0 0 2 0 0
/proc/29135/statm: 2292 331 280 229 0 52 0
Current children cumulated CPU time (s) 0
Current children cumulated vsize (KiB) 9168

[startup+0.202687 s]
/proc/loadavg: 1.01 1.04 1.03 2/60 29135
/proc/meminfo: memFree=690628/1022884 swapFree=0/0
[pid=29135] ppid=29134 vsize=9168 CPUtime=0
/proc/29135/stat : 29135 (p2cudf-full-1.1) S 29134 29135 32685 0 -1 4202496 454 290 2 1 0 0 0 0 20 0 1 0 42838304 9388032 331 18446744073709551615 4194304 5129932 140737433165920 140737433164064 139788051719262 0 65536 16781316 65538 0 0 0 17 0 0 0 2 0 0
/proc/29135/statm: 2292 331 280 229 0 52 0
Current children cumulated CPU time (s) 0
Current children cumulated vsize (KiB) 9168

[startup+0.300347 s]
/proc/loadavg: 1.01 1.04 1.03 2/60 29135
/proc/meminfo: memFree=690628/1022884 swapFree=0/0
[pid=29135] ppid=29134 vsize=9168 CPUtime=0
/proc/29135/stat : 29135 (p2cudf-full-1.1) S 29134 29135 32685 0 -1 4202496 454 290 2 1 0 0 0 0 20 0 1 0 42838304 9388032 331 18446744073709551615 4194304 5129932 140737433165920 140737433164064 139788051719262 0 65536 16781316 65538 0 0 0 17 0 0 0 2 0 0
/proc/29135/statm: 2292 331 280 229 0 52 0
Current children cumulated CPU time (s) 0
Current children cumulated vsize (KiB) 9168

[startup+0.702688 s]
/proc/loadavg: 1.01 1.04 1.03 2/60 29135
/proc/meminfo: memFree=690628/1022884 swapFree=0/0
[pid=29135] ppid=29134 vsize=9168 CPUtime=0
/proc/29135/stat : 29135 (p2cudf-full-1.1) S 29134 29135 32685 0 -1 4202496 454 290 2 1 0 0 0 0 20 0 1 0 42838304 9388032 331 18446744073709551615 4194304 5129932 140737433165920 140737433164064 139788051719262 0 65536 16781316 65538 0 0 0 17 0 0 0 2 0 0
/proc/29135/statm: 2292 331 280 229 0 52 0
Current children cumulated CPU time (s) 0
Current children cumulated vsize (KiB) 9168

[startup+1.50073 s]
/proc/loadavg: 1.01 1.04 1.03 2/71 29147
/proc/meminfo: memFree=650852/1022884 swapFree=0/0
[pid=29135] ppid=29134 vsize=9168 CPUtime=0
/proc/29135/stat : 29135 (p2cudf-full-1.1) S 29134 29135 32685 0 -1 4202496 454 290 2 1 0 0 0 0 20 0 1 0 42838304 9388032 331 18446744073709551615 4194304 5129932 140737433165920 140737433164064 139788051719262 0 65536 16781316 65538 0 0 0 17 0 0 0 2 0 0
/proc/29135/statm: 2292 331 280 229 0 52 0
[pid=29138] ppid=29135 vsize=1055548 CPUtime=1.34
/proc/29138/stat : 29138 (java) S 29135 29135 32685 0 -1 4202496 29459 0 19 0 120 14 0 0 20 0 10 0 42838309 1080881152 26670 18446744073709551615 4194304 4228012 140737203458224 140737203449248 140666291187317 0 0 0 16800975 18446744073709551615 0 0 17 0 0 0 4 0 0
/proc/29138/statm: 263887 26670 2348 9 0 251237 0
[pid=29138/tid=29139] ppid=29135 vsize=1055548 CPUtime=0.64
/proc/29138/task/29139/stat : 29139 (java) R 29135 29135 32685 0 -1 4202560 12670 0 7 0 54 10 0 0 20 0 10 0 42838315 1080881152 26670 18446744073709551615 4194304 4228012 140737203458224 140666297713312 140666195232999 0 4 0 16800975 0 0 0 -1 0 0 0 4 0 0
[pid=29138/tid=29140] ppid=29135 vsize=1055548 CPUtime=0
/proc/29138/task/29140/stat : 29140 (java) S 29135 29135 32685 0 -1 4202560 4 0 0 0 0 0 0 0 20 0 10 0 42838320 1080881152 26670 18446744073709551615 4194304 4228012 140737203458224 140666190359680 140666291201611 0 0 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29141] ppid=29135 vsize=1055548 CPUtime=0
/proc/29138/task/29141/stat : 29141 (java) S 29135 29135 32685 0 -1 4202560 15 0 0 0 0 0 0 0 20 0 10 0 42838321 1080881152 26670 18446744073709551615 4194304 4228012 140737203458224 140666189305872 140666291200724 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29142] ppid=29135 vsize=1055548 CPUtime=0
/proc/29138/task/29142/stat : 29142 (java) S 29135 29135 32685 0 -1 4202560 6 0 0 0 0 0 0 0 20 0 10 0 42838321 1080881152 26670 18446744073709551615 4194304 4228012 140737203458224 140666188253088 140666291200724 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29143] ppid=29135 vsize=1055548 CPUtime=0
/proc/29138/task/29143/stat : 29143 (java) S 29135 29135 32685 0 -1 4202560 1 0 0 0 0 0 0 0 20 0 10 0 42838324 1080881152 26670 18446744073709551615 4194304 4228012 140737203458224 140666187201520 140666291209248 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29144] ppid=29135 vsize=1055548 CPUtime=0.33
/proc/29138/task/29144/stat : 29144 (java) R 29135 29135 32685 0 -1 4202560 7773 0 0 0 30 3 0 0 20 0 10 0 42838324 1080881152 26670 18446744073709551615 4194304 4228012 140737203458224 140666186134168 140666283765166 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29145] ppid=29135 vsize=1055548 CPUtime=0.35
/proc/29138/task/29145/stat : 29145 (java) R 29135 29135 32685 0 -1 4202560 7734 0 0 0 34 1 0 0 20 0 10 0 42838324 1080881152 26670 18446744073709551615 4194304 4228012 140737203458224 140666185081416 140666276854321 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29146] ppid=29135 vsize=1055548 CPUtime=0
/proc/29138/task/29146/stat : 29146 (java) S 29135 29135 32685 0 -1 4202560 0 0 0 0 0 0 0 0 20 0 10 0 42838324 1080881152 26670 18446744073709551615 4194304 4228012 140737203458224 140666184043728 140666291200724 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29147] ppid=29135 vsize=1055548 CPUtime=0
/proc/29138/task/29147/stat : 29147 (java) S 29135 29135 32685 0 -1 4202560 0 0 0 0 0 0 0 0 20 0 10 0 42838324 1080881152 26670 18446744073709551615 4194304 4228012 140737203458224 140666182991232 140666291201611 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
Current children cumulated CPU time (s) 1.34
Current children cumulated vsize (KiB) 1064716

[startup+3.10077 s]
/proc/loadavg: 1.01 1.04 1.03 4/71 29147
/proc/meminfo: memFree=548056/1022884 swapFree=0/0
[pid=29135] ppid=29134 vsize=9168 CPUtime=0
/proc/29135/stat : 29135 (p2cudf-full-1.1) S 29134 29135 32685 0 -1 4202496 454 290 2 1 0 0 0 0 20 0 1 0 42838304 9388032 331 18446744073709551615 4194304 5129932 140737433165920 140737433164064 139788051719262 0 65536 16781316 65538 0 0 0 17 0 0 0 2 0 0
/proc/29135/statm: 2292 331 280 229 0 52 0
[pid=29138] ppid=29135 vsize=1059264 CPUtime=2.93
/proc/29138/stat : 29138 (java) S 29135 29135 32685 0 -1 4202496 76334 0 19 0 260 33 0 0 20 0 10 0 42838309 1084686336 71102 18446744073709551615 4194304 4228012 140737203458224 140737203449248 140666291187317 0 0 0 16800975 18446744073709551615 0 0 17 0 0 0 4 0 0
/proc/29138/statm: 264816 71102 2368 9 0 252166 0
[pid=29138/tid=29139] ppid=29135 vsize=1059264 CPUtime=1.42
/proc/29138/task/29139/stat : 29139 (java) R 29135 29135 32685 0 -1 4202560 47399 0 7 0 118 24 0 0 20 0 10 0 42838315 1084686336 71102 18446744073709551615 4194304 4228012 140737203458224 140666297713344 140666195386894 0 4 0 16800975 0 0 0 -1 0 0 0 5 0 0
[pid=29138/tid=29140] ppid=29135 vsize=1059264 CPUtime=0.16
/proc/29138/task/29140/stat : 29140 (java) S 29135 29135 32685 0 -1 4202560 7952 0 0 0 14 2 0 0 20 0 10 0 42838320 1084686336 71102 18446744073709551615 4194304 4228012 140737203458224 140666190359680 140666291201611 0 0 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29141] ppid=29135 vsize=1059264 CPUtime=0
/proc/29138/task/29141/stat : 29141 (java) S 29135 29135 32685 0 -1 4202560 16 0 0 0 0 0 0 0 20 0 10 0 42838321 1084686336 71102 18446744073709551615 4194304 4228012 140737203458224 140666189305872 140666291200724 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29142] ppid=29135 vsize=1059264 CPUtime=0
/proc/29138/task/29142/stat : 29142 (java) S 29135 29135 32685 0 -1 4202560 9 0 0 0 0 0 0 0 20 0 10 0 42838321 1084686336 71102 18446744073709551615 4194304 4228012 140737203458224 140666188253088 140666291200724 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29143] ppid=29135 vsize=1059264 CPUtime=0
/proc/29138/task/29143/stat : 29143 (java) S 29135 29135 32685 0 -1 4202560 1 0 0 0 0 0 0 0 20 0 10 0 42838324 1084686336 71102 18446744073709551615 4194304 4228012 140737203458224 140666187201520 140666291209248 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29144] ppid=29135 vsize=1059264 CPUtime=0.64
/proc/29138/task/29144/stat : 29144 (java) S 29135 29135 32685 0 -1 4202560 10638 0 0 0 59 5 0 0 20 0 10 0 42838324 1084686336 71102 18446744073709551615 4194304 4228012 140737203458224 140666186148880 140666291200724 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29145] ppid=29135 vsize=1059264 CPUtime=0.67
/proc/29138/task/29145/stat : 29145 (java) S 29135 29135 32685 0 -1 4202560 9063 0 0 0 66 1 0 0 20 0 10 0 42838324 1084686336 71102 18446744073709551615 4194304 4228012 140737203458224 140666185096208 140666291200724 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29146] ppid=29135 vsize=1059264 CPUtime=0
/proc/29138/task/29146/stat : 29146 (java) S 29135 29135 32685 0 -1 4202560 0 0 0 0 0 0 0 0 20 0 10 0 42838324 1084686336 71102 18446744073709551615 4194304 4228012 140737203458224 140666184043728 140666291200724 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29147] ppid=29135 vsize=1059264 CPUtime=0
/proc/29138/task/29147/stat : 29147 (java) S 29135 29135 32685 0 -1 4202560 0 0 0 0 0 0 0 0 20 0 10 0 42838324 1084686336 71102 18446744073709551615 4194304 4228012 140737203458224 140666182991232 140666291201611 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
Current children cumulated CPU time (s) 2.93
Current children cumulated vsize (KiB) 1068432

[startup+6.30076 s]
/proc/loadavg: 1.01 1.04 1.03 2/71 29147
/proc/meminfo: memFree=251820/1022884 swapFree=0/0
[pid=29135] ppid=29134 vsize=9168 CPUtime=0
/proc/29135/stat : 29135 (p2cudf-full-1.1) S 29134 29135 32685 0 -1 4202496 454 290 2 1 0 0 0 0 20 0 1 0 42838304 9388032 331 18446744073709551615 4194304 5129932 140737433165920 140737433164064 139788051719262 0 65536 16781316 65538 0 0 0 17 0 0 0 2 0 0
/proc/29135/statm: 2292 331 280 229 0 52 0
[pid=29138] ppid=29135 vsize=1049992 CPUtime=6.08
/proc/29138/stat : 29138 (java) S 29135 29135 32685 0 -1 4202496 121654 0 19 0 559 49 0 0 20 0 10 0 42838309 1075191808 114211 18446744073709551615 4194304 4228012 140737203458224 140737203449248 140666291187317 0 0 0 16800975 18446744073709551615 0 0 17 0 0 0 4 0 0
/proc/29138/statm: 262498 114211 2370 9 0 249848 0
[pid=29138/tid=29139] ppid=29135 vsize=1049992 CPUtime=3.38
/proc/29138/task/29139/stat : 29139 (java) R 29135 29135 32685 0 -1 4202560 47403 0 7 0 312 26 0 0 20 0 10 0 42838315 1075191808 114211 18446744073709551615 4194304 4228012 140737203458224 140666297713344 140666195594622 0 4 0 16800975 0 0 0 -1 0 0 0 6 0 0
[pid=29138/tid=29140] ppid=29135 vsize=1049992 CPUtime=1.27
/proc/29138/task/29140/stat : 29140 (java) S 29135 29135 32685 0 -1 4202560 53239 0 0 0 112 15 0 0 20 0 10 0 42838320 1075191808 114211 18446744073709551615 4194304 4228012 140737203458224 140666190359680 140666291201611 0 0 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29141] ppid=29135 vsize=1049992 CPUtime=0
/proc/29138/task/29141/stat : 29141 (java) S 29135 29135 32685 0 -1 4202560 16 0 0 0 0 0 0 0 20 0 10 0 42838321 1075191808 114211 18446744073709551615 4194304 4228012 140737203458224 140666189305872 140666291200724 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29142] ppid=29135 vsize=1049992 CPUtime=0
/proc/29138/task/29142/stat : 29142 (java) S 29135 29135 32685 0 -1 4202560 9 0 0 0 0 0 0 0 20 0 10 0 42838321 1075191808 114211 18446744073709551615 4194304 4228012 140737203458224 140666188253088 140666291200724 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29143] ppid=29135 vsize=1049992 CPUtime=0
/proc/29138/task/29143/stat : 29143 (java) S 29135 29135 32685 0 -1 4202560 1 0 0 0 0 0 0 0 20 0 10 0 42838324 1075191808 114211 18446744073709551615 4194304 4228012 140737203458224 140666187201520 140666291209248 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29144] ppid=29135 vsize=1049992 CPUtime=0.68
/proc/29138/task/29144/stat : 29144 (java) S 29135 29135 32685 0 -1 4202560 10667 0 0 0 63 5 0 0 20 0 10 0 42838324 1075191808 114211 18446744073709551615 4194304 4228012 140737203458224 140666186148880 140666291200724 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29145] ppid=29135 vsize=1049992 CPUtime=0.71
/proc/29138/task/29145/stat : 29145 (java) S 29135 29135 32685 0 -1 4202560 9063 0 0 0 70 1 0 0 20 0 10 0 42838324 1075191808 114211 18446744073709551615 4194304 4228012 140737203458224 140666185096208 140666291200724 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29146] ppid=29135 vsize=1049992 CPUtime=0
/proc/29138/task/29146/stat : 29146 (java) S 29135 29135 32685 0 -1 4202560 0 0 0 0 0 0 0 0 20 0 10 0 42838324 1075191808 114211 18446744073709551615 4194304 4228012 140737203458224 140666184043728 140666291200724 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29147] ppid=29135 vsize=1049992 CPUtime=0
/proc/29138/task/29147/stat : 29147 (java) S 29135 29135 32685 0 -1 4202560 0 0 0 0 0 0 0 0 20 0 10 0 42838324 1075191808 114211 18446744073709551615 4194304 4228012 140737203458224 140666182991232 140666291201611 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
Current children cumulated CPU time (s) 6.08
Current children cumulated vsize (KiB) 1059160

[startup+12.7008 s]
/proc/loadavg: 1.17 1.07 1.04 3/72 29148
/proc/meminfo: memFree=78708/1022884 swapFree=0/0
[pid=29135] ppid=29134 vsize=9168 CPUtime=0
/proc/29135/stat : 29135 (p2cudf-full-1.1) S 29134 29135 32685 0 -1 4202496 454 290 2 1 0 0 0 0 20 0 1 0 42838304 9388032 331 18446744073709551615 4194304 5129932 140737433165920 140737433164064 139788051719262 0 65536 16781316 65538 0 0 0 17 0 0 0 2 0 0
/proc/29135/statm: 2292 331 280 229 0 52 0
[pid=29138] ppid=29135 vsize=1051020 CPUtime=12.38
/proc/29138/stat : 29138 (java) S 29135 29135 32685 0 -1 4202496 154655 0 19 0 1178 60 0 0 20 0 11 0 42838309 1076244480 145985 18446744073709551615 4194304 4228012 140737203458224 140737203449248 140666291187317 0 0 0 16800975 18446744073709551615 0 0 17 0 0 0 4 0 0
/proc/29138/statm: 262755 145985 2381 9 0 250105 0
[pid=29138/tid=29139] ppid=29135 vsize=1051020 CPUtime=6.37
/proc/29138/task/29139/stat : 29139 (java) R 29135 29135 32685 0 -1 4202560 47785 0 7 0 610 27 0 0 20 0 11 0 42838315 1076244480 145985 18446744073709551615 4194304 4228012 140737203458224 140666297720616 140666196058988 0 4 0 16800975 0 0 0 -1 0 0 0 8 0 0
[pid=29138/tid=29140] ppid=29135 vsize=1051020 CPUtime=2.17
/proc/29138/task/29140/stat : 29140 (java) S 29135 29135 32685 0 -1 4202560 84017 0 0 0 192 25 0 0 20 0 11 0 42838320 1076244480 145985 18446744073709551615 4194304 4228012 140737203458224 140666190359680 140666291201611 0 0 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29141] ppid=29135 vsize=1051020 CPUtime=0
/proc/29138/task/29141/stat : 29141 (java) S 29135 29135 32685 0 -1 4202560 16 0 0 0 0 0 0 0 20 0 11 0 42838321 1076244480 145985 18446744073709551615 4194304 4228012 140737203458224 140666189305872 140666291200724 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29142] ppid=29135 vsize=1051020 CPUtime=0
/proc/29138/task/29142/stat : 29142 (java) S 29135 29135 32685 0 -1 4202560 9 0 0 0 0 0 0 0 20 0 11 0 42838321 1076244480 145985 18446744073709551615 4194304 4228012 140737203458224 140666188253088 140666291200724 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29143] ppid=29135 vsize=1051020 CPUtime=0
/proc/29138/task/29143/stat : 29143 (java) S 29135 29135 32685 0 -1 4202560 1 0 0 0 0 0 0 0 20 0 11 0 42838324 1076244480 145985 18446744073709551615 4194304 4228012 140737203458224 140666187201520 140666291209248 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29144] ppid=29135 vsize=1051020 CPUtime=1.79
/proc/29138/task/29144/stat : 29144 (java) S 29135 29135 32685 0 -1 4202560 12389 0 0 0 173 6 0 0 20 0 11 0 42838324 1076244480 145985 18446744073709551615 4194304 4228012 140737203458224 140666186148880 140666291200724 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29145] ppid=29135 vsize=1051020 CPUtime=2.01
/proc/29138/task/29145/stat : 29145 (java) S 29135 29135 32685 0 -1 4202560 9176 0 0 0 200 1 0 0 20 0 11 0 42838324 1076244480 145985 18446744073709551615 4194304 4228012 140737203458224 140666185096208 140666291200724 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29146] ppid=29135 vsize=1051020 CPUtime=0
/proc/29138/task/29146/stat : 29146 (java) S 29135 29135 32685 0 -1 4202560 0 0 0 0 0 0 0 0 20 0 11 0 42838324 1076244480 145985 18446744073709551615 4194304 4228012 140737203458224 140666184043728 140666291200724 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29147] ppid=29135 vsize=1051020 CPUtime=0.01
/proc/29138/task/29147/stat : 29147 (java) S 29135 29135 32685 0 -1 4202560 0 0 0 0 1 0 0 0 20 0 11 0 42838324 1076244480 145985 18446744073709551615 4194304 4228012 140737203458224 140666182991232 140666291201611 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29148] ppid=29135 vsize=1051020 CPUtime=0
/proc/29138/task/29148/stat : 29148 (java) S 29135 29135 32685 0 -1 4202560 6 0 0 0 0 0 0 0 20 0 11 0 42839435 1076244480 145985 18446744073709551615 4194304 4228012 140737203458224 140666181789536 140666291201611 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
Current children cumulated CPU time (s) 12.38
Current children cumulated vsize (KiB) 1060188

[startup+25.5006 s]
/proc/loadavg: 1.13 1.07 1.04 2/72 29148
/proc/meminfo: memFree=70400/1022884 swapFree=0/0
[pid=29135] ppid=29134 vsize=9168 CPUtime=0
/proc/29135/stat : 29135 (p2cudf-full-1.1) S 29134 29135 32685 0 -1 4202496 454 290 2 1 0 0 0 0 20 0 1 0 42838304 9388032 331 18446744073709551615 4194304 5129932 140737433165920 140737433164064 139788051719262 0 65536 16781316 65538 0 0 0 17 0 0 0 2 0 0
/proc/29135/statm: 2292 331 280 229 0 52 0
[pid=29138] ppid=29135 vsize=1030820 CPUtime=25.04
/proc/29138/stat : 29138 (java) S 29135 29135 32685 0 -1 4202496 161661 0 19 0 2440 64 0 0 20 0 11 0 42838309 1055559680 147910 18446744073709551615 4194304 4228012 140737203458224 140737203449248 140666291187317 0 0 0 16800975 18446744073709551615 0 0 17 0 0 0 4 0 0
/proc/29138/statm: 257705 147910 2393 9 0 245055 0
[pid=29138/tid=29139] ppid=29135 vsize=1030820 CPUtime=17.95
/proc/29138/task/29139/stat : 29139 (java) R 29135 29135 32685 0 -1 4202560 47787 0 7 0 1768 27 0 0 20 0 11 0 42838315 1055559680 147910 18446744073709551615 4194304 4228012 140737203458224 140666297720936 140666196363210 0 4 0 16800975 0 0 0 -1 0 0 0 8 0 0
[pid=29138/tid=29140] ppid=29135 vsize=1030820 CPUtime=2.96
/proc/29138/task/29140/stat : 29140 (java) S 29135 29135 32685 0 -1 4202560 90727 0 0 0 268 28 0 0 20 0 11 0 42838320 1055559680 147910 18446744073709551615 4194304 4228012 140737203458224 140666190359680 140666291201611 0 0 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29141] ppid=29135 vsize=1030820 CPUtime=0
/proc/29138/task/29141/stat : 29141 (java) S 29135 29135 32685 0 -1 4202560 16 0 0 0 0 0 0 0 20 0 11 0 42838321 1055559680 147910 18446744073709551615 4194304 4228012 140737203458224 140666189305872 140666291200724 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29142] ppid=29135 vsize=1030820 CPUtime=0
/proc/29138/task/29142/stat : 29142 (java) S 29135 29135 32685 0 -1 4202560 9 0 0 0 0 0 0 0 20 0 11 0 42838321 1055559680 147910 18446744073709551615 4194304 4228012 140737203458224 140666188253088 140666291200724 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29143] ppid=29135 vsize=1030820 CPUtime=0
/proc/29138/task/29143/stat : 29143 (java) S 29135 29135 32685 0 -1 4202560 1 0 0 0 0 0 0 0 20 0 11 0 42838324 1055559680 147910 18446744073709551615 4194304 4228012 140737203458224 140666187201520 140666291209248 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29144] ppid=29135 vsize=1030820 CPUtime=2.02
/proc/29138/task/29144/stat : 29144 (java) S 29135 29135 32685 0 -1 4202560 12683 0 0 0 196 6 0 0 20 0 11 0 42838324 1055559680 147910 18446744073709551615 4194304 4228012 140737203458224 140666186148880 140666291200724 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29145] ppid=29135 vsize=1030820 CPUtime=2.07
/proc/29138/task/29145/stat : 29145 (java) S 29135 29135 32685 0 -1 4202560 9176 0 0 0 206 1 0 0 20 0 11 0 42838324 1055559680 147910 18446744073709551615 4194304 4228012 140737203458224 140666185096208 140666291200724 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29146] ppid=29135 vsize=1030820 CPUtime=0
/proc/29138/task/29146/stat : 29146 (java) S 29135 29135 32685 0 -1 4202560 0 0 0 0 0 0 0 0 20 0 11 0 42838324 1055559680 147910 18446744073709551615 4194304 4228012 140737203458224 140666184043728 140666291200724 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29147] ppid=29135 vsize=1030820 CPUtime=0.02
/proc/29138/task/29147/stat : 29147 (java) S 29135 29135 32685 0 -1 4202560 0 0 0 0 1 1 0 0 20 0 11 0 42838324 1055559680 147910 18446744073709551615 4194304 4228012 140737203458224 140666182991232 140666291201611 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29148] ppid=29135 vsize=1030820 CPUtime=0
/proc/29138/task/29148/stat : 29148 (java) S 29135 29135 32685 0 -1 4202560 6 0 0 0 0 0 0 0 20 0 11 0 42839435 1055559680 147910 18446744073709551615 4194304 4228012 140737203458224 140666181789536 140666291201611 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
Current children cumulated CPU time (s) 25.04
Current children cumulated vsize (KiB) 1039988

[startup+51.1007 s]
/proc/loadavg: 1.16 1.08 1.05 2/78 29259
/proc/meminfo: memFree=59192/1022884 swapFree=0/0
[pid=29135] ppid=29134 vsize=9168 CPUtime=0
/proc/29135/stat : 29135 (p2cudf-full-1.1) S 29134 29135 32685 0 -1 4202496 454 290 2 1 0 0 0 0 20 0 1 0 42838304 9388032 331 18446744073709551615 4194304 5129932 140737433165920 140737433164064 139788051719262 0 65536 16781316 65538 0 0 0 17 0 0 0 2 0 0
/proc/29135/statm: 2292 331 280 229 0 52 0
[pid=29138] ppid=29135 vsize=1030820 CPUtime=48.55
/proc/29138/stat : 29138 (java) S 29135 29135 32685 0 -1 4202496 162694 0 19 0 4791 64 0 0 20 0 11 0 42838309 1055559680 148939 18446744073709551615 4194304 4228012 140737203458224 140737203449248 140666291187317 0 0 0 16800975 18446744073709551615 0 0 17 0 0 0 4 0 0
/proc/29138/statm: 257705 148939 2393 9 0 245055 0
[pid=29138/tid=29139] ppid=29135 vsize=1030820 CPUtime=39.02
/proc/29138/task/29139/stat : 29139 (java) R 29135 29135 32685 0 -1 4202560 47788 0 7 0 3875 27 0 0 20 0 11 0 42838315 1055559680 148939 18446744073709551615 4194304 4228012 140737203458224 140666297720808 140666196363170 0 4 0 16800975 0 0 0 -1 0 0 0 8 0 0
[pid=29138/tid=29140] ppid=29135 vsize=1030820 CPUtime=5.32
/proc/29138/task/29140/stat : 29140 (java) S 29135 29135 32685 0 -1 4202560 91756 0 0 0 504 28 0 0 20 0 11 0 42838320 1055559680 148939 18446744073709551615 4194304 4228012 140737203458224 140666190359680 140666291201611 0 0 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29141] ppid=29135 vsize=1030820 CPUtime=0
/proc/29138/task/29141/stat : 29141 (java) S 29135 29135 32685 0 -1 4202560 16 0 0 0 0 0 0 0 20 0 11 0 42838321 1055559680 148939 18446744073709551615 4194304 4228012 140737203458224 140666189305872 140666291200724 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29142] ppid=29135 vsize=1030820 CPUtime=0
/proc/29138/task/29142/stat : 29142 (java) S 29135 29135 32685 0 -1 4202560 9 0 0 0 0 0 0 0 20 0 11 0 42838321 1055559680 148939 18446744073709551615 4194304 4228012 140737203458224 140666188253088 140666291200724 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29143] ppid=29135 vsize=1030820 CPUtime=0
/proc/29138/task/29143/stat : 29143 (java) S 29135 29135 32685 0 -1 4202560 1 0 0 0 0 0 0 0 20 0 11 0 42838324 1055559680 148939 18446744073709551615 4194304 4228012 140737203458224 140666187201520 140666291209248 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29144] ppid=29135 vsize=1030820 CPUtime=2.05
/proc/29138/task/29144/stat : 29144 (java) S 29135 29135 32685 0 -1 4202560 12683 0 0 0 199 6 0 0 20 0 11 0 42838324 1055559680 148939 18446744073709551615 4194304 4228012 140737203458224 140666186148880 140666291200724 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29145] ppid=29135 vsize=1030820 CPUtime=2.1
/proc/29138/task/29145/stat : 29145 (java) S 29135 29135 32685 0 -1 4202560 9176 0 0 0 209 1 0 0 20 0 11 0 42838324 1055559680 148939 18446744073709551615 4194304 4228012 140737203458224 140666185096208 140666291200724 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29146] ppid=29135 vsize=1030820 CPUtime=0
/proc/29138/task/29146/stat : 29146 (java) S 29135 29135 32685 0 -1 4202560 0 0 0 0 0 0 0 0 20 0 11 0 42838324 1055559680 148939 18446744073709551615 4194304 4228012 140737203458224 140666184043728 140666291200724 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29147] ppid=29135 vsize=1030820 CPUtime=0.03
/proc/29138/task/29147/stat : 29147 (java) S 29135 29135 32685 0 -1 4202560 3 0 0 0 1 2 0 0 20 0 11 0 42838324 1055559680 148939 18446744073709551615 4194304 4228012 140737203458224 140666182991232 140666291201611 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29148] ppid=29135 vsize=1030820 CPUtime=0
/proc/29138/task/29148/stat : 29148 (java) S 29135 29135 32685 0 -1 4202560 6 0 0 0 0 0 0 0 20 0 11 0 42839435 1055559680 148939 18446744073709551615 4194304 4228012 140737203458224 140666181789536 140666291201611 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
Current children cumulated CPU time (s) 48.55
Current children cumulated vsize (KiB) 1039988

[startup+102.301 s]
/proc/loadavg: 1.15 1.09 1.05 2/72 29396
/proc/meminfo: memFree=17376/1022884 swapFree=0/0
[pid=29135] ppid=29134 vsize=9168 CPUtime=0
/proc/29135/stat : 29135 (p2cudf-full-1.1) S 29134 29135 32685 0 -1 4202496 454 290 2 1 0 0 0 0 20 0 1 0 42838304 9388032 331 18446744073709551615 4194304 5129932 140737433165920 140737433164064 139788051719262 0 65536 16781316 65538 0 0 0 17 0 0 0 2 0 0
/proc/29135/statm: 2292 331 280 229 0 52 0
[pid=29138] ppid=29135 vsize=1030820 CPUtime=95.94
/proc/29138/stat : 29138 (java) S 29135 29135 32685 0 -1 4202496 163661 0 19 0 9529 65 0 0 20 0 11 0 42838309 1055559680 149898 18446744073709551615 4194304 4228012 140737203458224 140737203449248 140666291187317 0 0 0 16800975 18446744073709551615 0 0 17 0 0 0 4 0 0
/proc/29138/statm: 257705 149898 2393 9 0 245055 0
[pid=29138/tid=29139] ppid=29135 vsize=1030820 CPUtime=82.74
/proc/29138/task/29139/stat : 29139 (java) R 29135 29135 32685 0 -1 4202560 47788 0 7 0 8246 28 0 0 20 0 11 0 42838315 1055559680 149898 18446744073709551615 4194304 4228012 140737203458224 140666297720808 140666195712811 0 4 0 16800975 0 0 0 -1 0 0 0 8 0 0
[pid=29138/tid=29140] ppid=29135 vsize=1030820 CPUtime=8.96
/proc/29138/task/29140/stat : 29140 (java) S 29135 29135 32685 0 -1 4202560 92717 0 0 0 868 28 0 0 20 0 11 0 42838320 1055559680 149898 18446744073709551615 4194304 4228012 140737203458224 140666190359680 140666291201611 0 0 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29141] ppid=29135 vsize=1030820 CPUtime=0
/proc/29138/task/29141/stat : 29141 (java) S 29135 29135 32685 0 -1 4202560 16 0 0 0 0 0 0 0 20 0 11 0 42838321 1055559680 149898 18446744073709551615 4194304 4228012 140737203458224 140666189305872 140666291200724 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29142] ppid=29135 vsize=1030820 CPUtime=0
/proc/29138/task/29142/stat : 29142 (java) S 29135 29135 32685 0 -1 4202560 9 0 0 0 0 0 0 0 20 0 11 0 42838321 1055559680 149898 18446744073709551615 4194304 4228012 140737203458224 140666188253088 140666291200724 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29143] ppid=29135 vsize=1030820 CPUtime=0
/proc/29138/task/29143/stat : 29143 (java) S 29135 29135 32685 0 -1 4202560 1 0 0 0 0 0 0 0 20 0 11 0 42838324 1055559680 149898 18446744073709551615 4194304 4228012 140737203458224 140666187201520 140666291209248 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29144] ppid=29135 vsize=1030820 CPUtime=2.05
/proc/29138/task/29144/stat : 29144 (java) S 29135 29135 32685 0 -1 4202560 12683 0 0 0 199 6 0 0 20 0 11 0 42838324 1055559680 149898 18446744073709551615 4194304 4228012 140737203458224 140666186148880 140666291200724 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29145] ppid=29135 vsize=1030820 CPUtime=2.1
/proc/29138/task/29145/stat : 29145 (java) S 29135 29135 32685 0 -1 4202560 9176 0 0 0 209 1 0 0 20 0 11 0 42838324 1055559680 149898 18446744073709551615 4194304 4228012 140737203458224 140666185096208 140666291200724 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29146] ppid=29135 vsize=1030820 CPUtime=0
/proc/29138/task/29146/stat : 29146 (java) S 29135 29135 32685 0 -1 4202560 0 0 0 0 0 0 0 0 20 0 11 0 42838324 1055559680 149898 18446744073709551615 4194304 4228012 140737203458224 140666184043728 140666291200724 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29147] ppid=29135 vsize=1030820 CPUtime=0.06
/proc/29138/task/29147/stat : 29147 (java) S 29135 29135 32685 0 -1 4202560 9 0 0 0 2 4 0 0 20 0 11 0 42838324 1055559680 149898 18446744073709551615 4194304 4228012 140737203458224 140666182991232 140666291201611 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29148] ppid=29135 vsize=1030820 CPUtime=0
/proc/29138/task/29148/stat : 29148 (java) S 29135 29135 32685 0 -1 4202560 6 0 0 0 0 0 0 0 20 0 11 0 42839435 1055559680 149898 18446744073709551615 4194304 4228012 140737203458224 140666181789536 140666291201611 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
Current children cumulated CPU time (s) 95.94
Current children cumulated vsize (KiB) 1039988

[startup+162.301 s]
/proc/loadavg: 1.05 1.07 1.05 2/72 29396
/proc/meminfo: memFree=9528/1022884 swapFree=0/0
[pid=29135] ppid=29134 vsize=9168 CPUtime=0
/proc/29135/stat : 29135 (p2cudf-full-1.1) S 29134 29135 32685 0 -1 4202496 454 290 2 1 0 0 0 0 20 0 1 0 42838304 9388032 331 18446744073709551615 4194304 5129932 140737433165920 140737433164064 139788051719262 0 65536 16781316 65538 0 0 0 17 0 0 0 2 0 0
/proc/29135/statm: 2292 331 280 229 0 52 0
[pid=29138] ppid=29135 vsize=1030820 CPUtime=155.41
/proc/29138/stat : 29138 (java) S 29135 29135 32685 0 -1 4202496 166890 0 19 0 15475 66 0 0 20 0 11 0 42838309 1055559680 153123 18446744073709551615 4194304 4228012 140737203458224 140737203449248 140666291187317 0 0 0 16800975 18446744073709551615 0 0 17 0 0 0 4 0 0
/proc/29138/statm: 257705 153123 2393 9 0 245055 0
[pid=29138/tid=29139] ppid=29135 vsize=1030820 CPUtime=138.66
/proc/29138/task/29139/stat : 29139 (java) R 29135 29135 32685 0 -1 4202560 47788 0 7 0 13838 28 0 0 20 0 11 0 42838315 1055559680 153123 18446744073709551615 4194304 4228012 140737203458224 140666297720808 140666196020115 0 4 0 16800975 0 0 0 -1 0 0 0 8 0 0
[pid=29138/tid=29140] ppid=29135 vsize=1030820 CPUtime=12.47
/proc/29138/task/29140/stat : 29140 (java) S 29135 29135 32685 0 -1 4202560 95943 0 0 0 1218 29 0 0 20 0 11 0 42838320 1055559680 153123 18446744073709551615 4194304 4228012 140737203458224 140666190359680 140666291201611 0 0 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29141] ppid=29135 vsize=1030820 CPUtime=0
/proc/29138/task/29141/stat : 29141 (java) S 29135 29135 32685 0 -1 4202560 16 0 0 0 0 0 0 0 20 0 11 0 42838321 1055559680 153123 18446744073709551615 4194304 4228012 140737203458224 140666189305872 140666291200724 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29142] ppid=29135 vsize=1030820 CPUtime=0
/proc/29138/task/29142/stat : 29142 (java) S 29135 29135 32685 0 -1 4202560 9 0 0 0 0 0 0 0 20 0 11 0 42838321 1055559680 153123 18446744073709551615 4194304 4228012 140737203458224 140666188253088 140666291200724 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29143] ppid=29135 vsize=1030820 CPUtime=0
/proc/29138/task/29143/stat : 29143 (java) S 29135 29135 32685 0 -1 4202560 1 0 0 0 0 0 0 0 20 0 11 0 42838324 1055559680 153123 18446744073709551615 4194304 4228012 140737203458224 140666187201520 140666291209248 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29144] ppid=29135 vsize=1030820 CPUtime=2.05
/proc/29138/task/29144/stat : 29144 (java) S 29135 29135 32685 0 -1 4202560 12683 0 0 0 199 6 0 0 20 0 11 0 42838324 1055559680 153123 18446744073709551615 4194304 4228012 140737203458224 140666186148880 140666291200724 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29145] ppid=29135 vsize=1030820 CPUtime=2.11
/proc/29138/task/29145/stat : 29145 (java) S 29135 29135 32685 0 -1 4202560 9176 0 0 0 210 1 0 0 20 0 11 0 42838324 1055559680 153123 18446744073709551615 4194304 4228012 140737203458224 140666185096208 140666291200724 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29146] ppid=29135 vsize=1030820 CPUtime=0
/proc/29138/task/29146/stat : 29146 (java) S 29135 29135 32685 0 -1 4202560 0 0 0 0 0 0 0 0 20 0 11 0 42838324 1055559680 153123 18446744073709551615 4194304 4228012 140737203458224 140666184043728 140666291200724 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29147] ppid=29135 vsize=1030820 CPUtime=0.08
/proc/29138/task/29147/stat : 29147 (java) S 29135 29135 32685 0 -1 4202560 12 0 0 0 2 6 0 0 20 0 11 0 42838324 1055559680 153123 18446744073709551615 4194304 4228012 140737203458224 140666182991232 140666291201611 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29148] ppid=29135 vsize=1030820 CPUtime=0
/proc/29138/task/29148/stat : 29148 (java) S 29135 29135 32685 0 -1 4202560 6 0 0 0 0 0 0 0 20 0 11 0 42839435 1055559680 153123 18446744073709551615 4194304 4228012 140737203458224 140666181789536 140666291201611 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
Current children cumulated CPU time (s) 155.41
Current children cumulated vsize (KiB) 1039988

[startup+222.304 s]
/proc/loadavg: 1.02 1.06 1.04 2/72 29396
/proc/meminfo: memFree=9404/1022884 swapFree=0/0
[pid=29135] ppid=29134 vsize=9168 CPUtime=0
/proc/29135/stat : 29135 (p2cudf-full-1.1) S 29134 29135 32685 0 -1 4202496 454 290 2 1 0 0 0 0 20 0 1 0 42838304 9388032 331 18446744073709551615 4194304 5129932 140737433165920 140737433164064 139788051719262 0 65536 16781316 65538 0 0 0 17 0 0 0 2 0 0
/proc/29135/statm: 2292 331 280 229 0 52 0
[pid=29138] ppid=29135 vsize=1030820 CPUtime=214.92
/proc/29138/stat : 29138 (java) S 29135 29135 32685 0 -1 4202496 166898 0 19 0 21426 66 0 0 20 0 11 0 42838309 1055559680 153123 18446744073709551615 4194304 4228012 140737203458224 140737203449248 140666291187317 0 0 0 16800975 18446744073709551615 0 0 17 0 0 0 4 0 0
/proc/29138/statm: 257705 153123 2393 9 0 245055 0
[pid=29138/tid=29139] ppid=29135 vsize=1030820 CPUtime=195.28
/proc/29138/task/29139/stat : 29139 (java) R 29135 29135 32685 0 -1 4202560 47788 0 7 0 19500 28 0 0 20 0 11 0 42838315 1055559680 153123 18446744073709551615 4194304 4228012 140737203458224 140666297720808 140666195730441 0 4 0 16800975 0 0 0 -1 0 0 0 8 0 0
[pid=29138/tid=29140] ppid=29135 vsize=1030820 CPUtime=15.32
/proc/29138/task/29140/stat : 29140 (java) S 29135 29135 32685 0 -1 4202560 95945 0 0 0 1503 29 0 0 20 0 11 0 42838320 1055559680 153123 18446744073709551615 4194304 4228012 140737203458224 140666190359680 140666291201611 0 0 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29141] ppid=29135 vsize=1030820 CPUtime=0
/proc/29138/task/29141/stat : 29141 (java) S 29135 29135 32685 0 -1 4202560 16 0 0 0 0 0 0 0 20 0 11 0 42838321 1055559680 153123 18446744073709551615 4194304 4228012 140737203458224 140666189305872 140666291200724 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29142] ppid=29135 vsize=1030820 CPUtime=0
/proc/29138/task/29142/stat : 29142 (java) S 29135 29135 32685 0 -1 4202560 9 0 0 0 0 0 0 0 20 0 11 0 42838321 1055559680 153123 18446744073709551615 4194304 4228012 140737203458224 140666188253088 140666291200724 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29143] ppid=29135 vsize=1030820 CPUtime=0
/proc/29138/task/29143/stat : 29143 (java) S 29135 29135 32685 0 -1 4202560 1 0 0 0 0 0 0 0 20 0 11 0 42838324 1055559680 153123 18446744073709551615 4194304 4228012 140737203458224 140666187201520 140666291209248 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29144] ppid=29135 vsize=1030820 CPUtime=2.05
/proc/29138/task/29144/stat : 29144 (java) S 29135 29135 32685 0 -1 4202560 12683 0 0 0 199 6 0 0 20 0 11 0 42838324 1055559680 153123 18446744073709551615 4194304 4228012 140737203458224 140666186148880 140666291200724 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29145] ppid=29135 vsize=1030820 CPUtime=2.11
/proc/29138/task/29145/stat : 29145 (java) S 29135 29135 32685 0 -1 4202560 9176 0 0 0 210 1 0 0 20 0 11 0 42838324 1055559680 153123 18446744073709551615 4194304 4228012 140737203458224 140666185096208 140666291200724 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29146] ppid=29135 vsize=1030820 CPUtime=0
/proc/29138/task/29146/stat : 29146 (java) S 29135 29135 32685 0 -1 4202560 0 0 0 0 0 0 0 0 20 0 11 0 42838324 1055559680 153123 18446744073709551615 4194304 4228012 140737203458224 140666184043728 140666291200724 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29147] ppid=29135 vsize=1030820 CPUtime=0.12
/proc/29138/task/29147/stat : 29147 (java) S 29135 29135 32685 0 -1 4202560 18 0 0 0 4 8 0 0 20 0 11 0 42838324 1055559680 153123 18446744073709551615 4194304 4228012 140737203458224 140666182991232 140666291201611 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29148] ppid=29135 vsize=1030820 CPUtime=0
/proc/29138/task/29148/stat : 29148 (java) S 29135 29135 32685 0 -1 4202560 6 0 0 0 0 0 0 0 20 0 11 0 42839435 1055559680 153123 18446744073709551615 4194304 4228012 140737203458224 140666181789536 140666291201611 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
Current children cumulated CPU time (s) 214.92
Current children cumulated vsize (KiB) 1039988

[startup+282.301 s]
/proc/loadavg: 1.06 1.06 1.04 2/68 29508
/proc/meminfo: memFree=14692/1022884 swapFree=0/0
[pid=29135] ppid=29134 vsize=9168 CPUtime=0
/proc/29135/stat : 29135 (p2cudf-full-1.1) S 29134 29135 32685 0 -1 4202496 454 290 2 1 0 0 0 0 20 0 1 0 42838304 9388032 331 18446744073709551615 4194304 5129932 140737433165920 140737433164064 139788051719262 0 65536 16781316 65538 0 0 0 17 0 0 0 2 0 0
/proc/29135/statm: 2292 331 280 229 0 52 0
[pid=29138] ppid=29135 vsize=1030820 CPUtime=271.82
/proc/29138/stat : 29138 (java) S 29135 29135 32685 0 -1 4202496 167076 0 19 0 27116 66 0 0 20 0 11 0 42838309 1055559680 153282 18446744073709551615 4194304 4228012 140737203458224 140737203449248 140666291187317 0 0 0 16800975 18446744073709551615 0 0 17 0 0 0 4 0 0
/proc/29138/statm: 257705 153282 2381 9 0 245055 0
[pid=29138/tid=29139] ppid=29135 vsize=1030820 CPUtime=249.29
/proc/29138/task/29139/stat : 29139 (java) R 29135 29135 32685 0 -1 4202560 47788 0 7 0 24900 29 0 0 20 0 11 0 42838315 1055559680 153282 18446744073709551615 4194304 4228012 140737203458224 140666297720808 140666195759260 0 4 0 16800975 0 0 0 -1 0 0 0 8 0 0
[pid=29138/tid=29140] ppid=29135 vsize=1030820 CPUtime=18.19
/proc/29138/task/29140/stat : 29140 (java) S 29135 29135 32685 0 -1 4202560 96117 0 0 0 1790 29 0 0 20 0 11 0 42838320 1055559680 153282 18446744073709551615 4194304 4228012 140737203458224 140666190359680 140666291201611 0 0 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29141] ppid=29135 vsize=1030820 CPUtime=0
/proc/29138/task/29141/stat : 29141 (java) S 29135 29135 32685 0 -1 4202560 16 0 0 0 0 0 0 0 20 0 11 0 42838321 1055559680 153282 18446744073709551615 4194304 4228012 140737203458224 140666189305872 140666291200724 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29142] ppid=29135 vsize=1030820 CPUtime=0
/proc/29138/task/29142/stat : 29142 (java) S 29135 29135 32685 0 -1 4202560 9 0 0 0 0 0 0 0 20 0 11 0 42838321 1055559680 153282 18446744073709551615 4194304 4228012 140737203458224 140666188253088 140666291200724 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29143] ppid=29135 vsize=1030820 CPUtime=0
/proc/29138/task/29143/stat : 29143 (java) S 29135 29135 32685 0 -1 4202560 1 0 0 0 0 0 0 0 20 0 11 0 42838324 1055559680 153282 18446744073709551615 4194304 4228012 140737203458224 140666187201520 140666291209248 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29144] ppid=29135 vsize=1030820 CPUtime=2.05
/proc/29138/task/29144/stat : 29144 (java) S 29135 29135 32685 0 -1 4202560 12683 0 0 0 199 6 0 0 20 0 11 0 42838324 1055559680 153282 18446744073709551615 4194304 4228012 140737203458224 140666186148880 140666291200724 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29145] ppid=29135 vsize=1030820 CPUtime=2.11
/proc/29138/task/29145/stat : 29145 (java) S 29135 29135 32685 0 -1 4202560 9176 0 0 0 210 1 0 0 20 0 11 0 42838324 1055559680 153282 18446744073709551615 4194304 4228012 140737203458224 140666185096208 140666291200724 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29146] ppid=29135 vsize=1030820 CPUtime=0
/proc/29138/task/29146/stat : 29146 (java) S 29135 29135 32685 0 -1 4202560 0 0 0 0 0 0 0 0 20 0 11 0 42838324 1055559680 153282 18446744073709551615 4194304 4228012 140737203458224 140666184043728 140666291200724 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29147] ppid=29135 vsize=1030820 CPUtime=0.13
/proc/29138/task/29147/stat : 29147 (java) S 29135 29135 32685 0 -1 4202560 24 0 0 0 4 9 0 0 20 0 11 0 42838324 1055559680 153282 18446744073709551615 4194304 4228012 140737203458224 140666182991232 140666291201611 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29148] ppid=29135 vsize=1030820 CPUtime=0
/proc/29138/task/29148/stat : 29148 (java) S 29135 29135 32685 0 -1 4202560 6 0 0 0 0 0 0 0 20 0 11 0 42839435 1055559680 153282 18446744073709551615 4194304 4228012 140737203458224 140666181789536 140666291201611 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
Current children cumulated CPU time (s) 271.82
Current children cumulated vsize (KiB) 1039988

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

[startup+288.001 s]
/proc/loadavg: 1.05 1.06 1.04 2/68 29508
/proc/meminfo: memFree=10104/1022884 swapFree=0/0
[pid=29135] ppid=29134 vsize=9168 CPUtime=0
/proc/29135/stat : 29135 (p2cudf-full-1.1) S 29134 29135 32685 0 -1 4202496 454 290 2 1 0 0 0 0 20 0 1 0 42838304 9388032 331 18446744073709551615 4194304 5129932 140737433165920 140737433164064 139788051719262 0 65536 16781316 65538 0 0 0 17 0 0 0 2 0 0
/proc/29135/statm: 2292 331 280 229 0 52 0
[pid=29138] ppid=29135 vsize=1030820 CPUtime=277.47
/proc/29138/stat : 29138 (java) S 29135 29135 32685 0 -1 4202496 171756 0 19 0 27679 68 0 0 20 0 11 0 42838309 1055559680 157961 18446744073709551615 4194304 4228012 140737203458224 140737203449248 140666291187317 0 0 0 16800975 18446744073709551615 0 0 17 0 0 0 4 0 0
/proc/29138/statm: 257705 157961 2381 9 0 245055 0
[pid=29138/tid=29139] ppid=29135 vsize=1030820 CPUtime=254.18
/proc/29138/task/29139/stat : 29139 (java) R 29135 29135 32685 0 -1 4202560 47788 0 7 0 25389 29 0 0 20 0 11 0 42838315 1055559680 157961 18446744073709551615 4194304 4228012 140737203458224 140666297720808 140666196020129 0 4 0 16800975 0 0 0 -1 0 0 0 8 0 0
[pid=29138/tid=29140] ppid=29135 vsize=1030820 CPUtime=18.92
/proc/29138/task/29140/stat : 29140 (java) S 29135 29135 32685 0 -1 4202560 100797 0 0 0 1862 30 0 0 20 0 11 0 42838320 1055559680 157961 18446744073709551615 4194304 4228012 140737203458224 140666190359680 140666291201611 0 0 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29141] ppid=29135 vsize=1030820 CPUtime=0
/proc/29138/task/29141/stat : 29141 (java) S 29135 29135 32685 0 -1 4202560 16 0 0 0 0 0 0 0 20 0 11 0 42838321 1055559680 157961 18446744073709551615 4194304 4228012 140737203458224 140666189305872 140666291200724 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29142] ppid=29135 vsize=1030820 CPUtime=0
/proc/29138/task/29142/stat : 29142 (java) S 29135 29135 32685 0 -1 4202560 9 0 0 0 0 0 0 0 20 0 11 0 42838321 1055559680 157961 18446744073709551615 4194304 4228012 140737203458224 140666188253088 140666291200724 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29143] ppid=29135 vsize=1030820 CPUtime=0
/proc/29138/task/29143/stat : 29143 (java) S 29135 29135 32685 0 -1 4202560 1 0 0 0 0 0 0 0 20 0 11 0 42838324 1055559680 157961 18446744073709551615 4194304 4228012 140737203458224 140666187201520 140666291209248 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29144] ppid=29135 vsize=1030820 CPUtime=2.07
/proc/29138/task/29144/stat : 29144 (java) S 29135 29135 32685 0 -1 4202560 12683 0 0 0 201 6 0 0 20 0 11 0 42838324 1055559680 157961 18446744073709551615 4194304 4228012 140737203458224 140666186148880 140666291200724 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29145] ppid=29135 vsize=1030820 CPUtime=2.11
/proc/29138/task/29145/stat : 29145 (java) S 29135 29135 32685 0 -1 4202560 9176 0 0 0 210 1 0 0 20 0 11 0 42838324 1055559680 157961 18446744073709551615 4194304 4228012 140737203458224 140666185096208 140666291200724 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29146] ppid=29135 vsize=1030820 CPUtime=0
/proc/29138/task/29146/stat : 29146 (java) S 29135 29135 32685 0 -1 4202560 0 0 0 0 0 0 0 0 20 0 11 0 42838324 1055559680 157961 18446744073709551615 4194304 4228012 140737203458224 140666184043728 140666291200724 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29147] ppid=29135 vsize=1030820 CPUtime=0.14
/proc/29138/task/29147/stat : 29147 (java) S 29135 29135 32685 0 -1 4202560 24 0 0 0 4 10 0 0 20 0 11 0 42838324 1055559680 157961 18446744073709551615 4194304 4228012 140737203458224 140666182991232 140666291201611 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29148] ppid=29135 vsize=1030820 CPUtime=0
/proc/29138/task/29148/stat : 29148 (java) S 29135 29135 32685 0 -1 4202560 6 0 0 0 0 0 0 0 20 0 11 0 42839435 1055559680 157961 18446744073709551615 4194304 4228012 140737203458224 140666181789536 140666291201611 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
Current children cumulated CPU time (s) 277.47
Current children cumulated vsize (KiB) 1039988

[startup+291.201 s]
/proc/loadavg: 1.05 1.06 1.04 2/68 29508
/proc/meminfo: memFree=10104/1022884 swapFree=0/0
[pid=29135] ppid=29134 vsize=9168 CPUtime=0
/proc/29135/stat : 29135 (p2cudf-full-1.1) S 29134 29135 32685 0 -1 4202496 454 290 2 1 0 0 0 0 20 0 1 0 42838304 9388032 331 18446744073709551615 4194304 5129932 140737433165920 140737433164064 139788051719262 0 65536 16781316 65538 0 0 0 17 0 0 0 2 0 0
/proc/29135/statm: 2292 331 280 229 0 52 0
[pid=29138] ppid=29135 vsize=1030820 CPUtime=280.64
/proc/29138/stat : 29138 (java) S 29135 29135 32685 0 -1 4202496 171756 0 19 0 27996 68 0 0 20 0 11 0 42838309 1055559680 157961 18446744073709551615 4194304 4228012 140737203458224 140737203449248 140666291187317 0 0 0 16800975 18446744073709551615 0 0 17 0 0 0 4 0 0
/proc/29138/statm: 257705 157961 2381 9 0 245055 0
[pid=29138/tid=29139] ppid=29135 vsize=1030820 CPUtime=257.35
/proc/29138/task/29139/stat : 29139 (java) R 29135 29135 32685 0 -1 4202560 47788 0 7 0 25706 29 0 0 20 0 11 0 42838315 1055559680 157961 18446744073709551615 4194304 4228012 140737203458224 140666297720808 140666196361952 0 4 0 16800975 0 0 0 -1 0 0 0 8 0 0
[pid=29138/tid=29140] ppid=29135 vsize=1030820 CPUtime=18.92
/proc/29138/task/29140/stat : 29140 (java) S 29135 29135 32685 0 -1 4202560 100797 0 0 0 1862 30 0 0 20 0 11 0 42838320 1055559680 157961 18446744073709551615 4194304 4228012 140737203458224 140666190359680 140666291201611 0 0 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29141] ppid=29135 vsize=1030820 CPUtime=0
/proc/29138/task/29141/stat : 29141 (java) S 29135 29135 32685 0 -1 4202560 16 0 0 0 0 0 0 0 20 0 11 0 42838321 1055559680 157961 18446744073709551615 4194304 4228012 140737203458224 140666189305872 140666291200724 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29142] ppid=29135 vsize=1030820 CPUtime=0
/proc/29138/task/29142/stat : 29142 (java) S 29135 29135 32685 0 -1 4202560 9 0 0 0 0 0 0 0 20 0 11 0 42838321 1055559680 157961 18446744073709551615 4194304 4228012 140737203458224 140666188253088 140666291200724 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29143] ppid=29135 vsize=1030820 CPUtime=0
/proc/29138/task/29143/stat : 29143 (java) S 29135 29135 32685 0 -1 4202560 1 0 0 0 0 0 0 0 20 0 11 0 42838324 1055559680 157961 18446744073709551615 4194304 4228012 140737203458224 140666187201520 140666291209248 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29144] ppid=29135 vsize=1030820 CPUtime=2.07
/proc/29138/task/29144/stat : 29144 (java) S 29135 29135 32685 0 -1 4202560 12683 0 0 0 201 6 0 0 20 0 11 0 42838324 1055559680 157961 18446744073709551615 4194304 4228012 140737203458224 140666186148880 140666291200724 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29145] ppid=29135 vsize=1030820 CPUtime=2.11
/proc/29138/task/29145/stat : 29145 (java) S 29135 29135 32685 0 -1 4202560 9176 0 0 0 210 1 0 0 20 0 11 0 42838324 1055559680 157961 18446744073709551615 4194304 4228012 140737203458224 140666185096208 140666291200724 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29146] ppid=29135 vsize=1030820 CPUtime=0
/proc/29138/task/29146/stat : 29146 (java) S 29135 29135 32685 0 -1 4202560 0 0 0 0 0 0 0 0 20 0 11 0 42838324 1055559680 157961 18446744073709551615 4194304 4228012 140737203458224 140666184043728 140666291200724 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29147] ppid=29135 vsize=1030820 CPUtime=0.14
/proc/29138/task/29147/stat : 29147 (java) S 29135 29135 32685 0 -1 4202560 24 0 0 0 4 10 0 0 20 0 11 0 42838324 1055559680 157961 18446744073709551615 4194304 4228012 140737203458224 140666182991232 140666291201611 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29148] ppid=29135 vsize=1030820 CPUtime=0
/proc/29138/task/29148/stat : 29148 (java) S 29135 29135 32685 0 -1 4202560 6 0 0 0 0 0 0 0 20 0 11 0 42839435 1055559680 157961 18446744073709551615 4194304 4228012 140737203458224 140666181789536 140666291201611 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
Current children cumulated CPU time (s) 280.64
Current children cumulated vsize (KiB) 1039988

[startup+294.401 s]
/proc/loadavg: 1.05 1.06 1.04 2/68 29508
/proc/meminfo: memFree=10104/1022884 swapFree=0/0
[pid=29135] ppid=29134 vsize=9168 CPUtime=0
/proc/29135/stat : 29135 (p2cudf-full-1.1) S 29134 29135 32685 0 -1 4202496 454 290 2 1 0 0 0 0 20 0 1 0 42838304 9388032 331 18446744073709551615 4194304 5129932 140737433165920 140737433164064 139788051719262 0 65536 16781316 65538 0 0 0 17 0 0 0 2 0 0
/proc/29135/statm: 2292 331 280 229 0 52 0
[pid=29138] ppid=29135 vsize=1030820 CPUtime=283.82
/proc/29138/stat : 29138 (java) S 29135 29135 32685 0 -1 4202496 171756 0 19 0 28314 68 0 0 20 0 11 0 42838309 1055559680 157961 18446744073709551615 4194304 4228012 140737203458224 140737203449248 140666291187317 0 0 0 16800975 18446744073709551615 0 0 17 0 0 0 4 0 0
/proc/29138/statm: 257705 157961 2381 9 0 245055 0
[pid=29138/tid=29139] ppid=29135 vsize=1030820 CPUtime=260.53
/proc/29138/task/29139/stat : 29139 (java) R 29135 29135 32685 0 -1 4202560 47788 0 7 0 26024 29 0 0 20 0 11 0 42838315 1055559680 157961 18446744073709551615 4194304 4228012 140737203458224 140666297720808 140666196363193 0 4 0 16800975 0 0 0 -1 0 0 0 8 0 0
[pid=29138/tid=29140] ppid=29135 vsize=1030820 CPUtime=18.92
/proc/29138/task/29140/stat : 29140 (java) S 29135 29135 32685 0 -1 4202560 100797 0 0 0 1862 30 0 0 20 0 11 0 42838320 1055559680 157961 18446744073709551615 4194304 4228012 140737203458224 140666190359680 140666291201611 0 0 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29141] ppid=29135 vsize=1030820 CPUtime=0
/proc/29138/task/29141/stat : 29141 (java) S 29135 29135 32685 0 -1 4202560 16 0 0 0 0 0 0 0 20 0 11 0 42838321 1055559680 157961 18446744073709551615 4194304 4228012 140737203458224 140666189305872 140666291200724 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29142] ppid=29135 vsize=1030820 CPUtime=0
/proc/29138/task/29142/stat : 29142 (java) S 29135 29135 32685 0 -1 4202560 9 0 0 0 0 0 0 0 20 0 11 0 42838321 1055559680 157961 18446744073709551615 4194304 4228012 140737203458224 140666188253088 140666291200724 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29143] ppid=29135 vsize=1030820 CPUtime=0
/proc/29138/task/29143/stat : 29143 (java) S 29135 29135 32685 0 -1 4202560 1 0 0 0 0 0 0 0 20 0 11 0 42838324 1055559680 157961 18446744073709551615 4194304 4228012 140737203458224 140666187201520 140666291209248 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29144] ppid=29135 vsize=1030820 CPUtime=2.07
/proc/29138/task/29144/stat : 29144 (java) S 29135 29135 32685 0 -1 4202560 12683 0 0 0 201 6 0 0 20 0 11 0 42838324 1055559680 157961 18446744073709551615 4194304 4228012 140737203458224 140666186148880 140666291200724 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29145] ppid=29135 vsize=1030820 CPUtime=2.11
/proc/29138/task/29145/stat : 29145 (java) S 29135 29135 32685 0 -1 4202560 9176 0 0 0 210 1 0 0 20 0 11 0 42838324 1055559680 157961 18446744073709551615 4194304 4228012 140737203458224 140666185096208 140666291200724 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29146] ppid=29135 vsize=1030820 CPUtime=0
/proc/29138/task/29146/stat : 29146 (java) S 29135 29135 32685 0 -1 4202560 0 0 0 0 0 0 0 0 20 0 11 0 42838324 1055559680 157961 18446744073709551615 4194304 4228012 140737203458224 140666184043728 140666291200724 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29147] ppid=29135 vsize=1030820 CPUtime=0.14
/proc/29138/task/29147/stat : 29147 (java) S 29135 29135 32685 0 -1 4202560 24 0 0 0 4 10 0 0 20 0 11 0 42838324 1055559680 157961 18446744073709551615 4194304 4228012 140737203458224 140666182991232 140666291201611 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29148] ppid=29135 vsize=1030820 CPUtime=0
/proc/29138/task/29148/stat : 29148 (java) S 29135 29135 32685 0 -1 4202560 6 0 0 0 0 0 0 0 20 0 11 0 42839435 1055559680 157961 18446744073709551615 4194304 4228012 140737203458224 140666181789536 140666291201611 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
Current children cumulated CPU time (s) 283.82
Current children cumulated vsize (KiB) 1039988

[startup+296.003 s]
/proc/loadavg: 1.04 1.06 1.04 2/68 29508
/proc/meminfo: memFree=10104/1022884 swapFree=0/0
[pid=29135] ppid=29134 vsize=9168 CPUtime=0
/proc/29135/stat : 29135 (p2cudf-full-1.1) S 29134 29135 32685 0 -1 4202496 454 290 2 1 0 0 0 0 20 0 1 0 42838304 9388032 331 18446744073709551615 4194304 5129932 140737433165920 140737433164064 139788051719262 0 65536 16781316 65538 0 0 0 17 0 0 0 2 0 0
/proc/29135/statm: 2292 331 280 229 0 52 0
[pid=29138] ppid=29135 vsize=1030820 CPUtime=285.41
/proc/29138/stat : 29138 (java) S 29135 29135 32685 0 -1 4202496 171756 0 19 0 28473 68 0 0 20 0 11 0 42838309 1055559680 157961 18446744073709551615 4194304 4228012 140737203458224 140737203449248 140666291187317 0 0 0 16800975 18446744073709551615 0 0 17 0 0 0 4 0 0
/proc/29138/statm: 257705 157961 2381 9 0 245055 0
[pid=29138/tid=29139] ppid=29135 vsize=1030820 CPUtime=262.11
/proc/29138/task/29139/stat : 29139 (java) R 29135 29135 32685 0 -1 4202560 47788 0 7 0 26182 29 0 0 20 0 11 0 42838315 1055559680 157961 18446744073709551615 4194304 4228012 140737203458224 140666297720808 140666196363210 0 4 0 16800975 0 0 0 -1 0 0 0 8 0 0
[pid=29138/tid=29140] ppid=29135 vsize=1030820 CPUtime=18.92
/proc/29138/task/29140/stat : 29140 (java) S 29135 29135 32685 0 -1 4202560 100797 0 0 0 1862 30 0 0 20 0 11 0 42838320 1055559680 157961 18446744073709551615 4194304 4228012 140737203458224 140666190359680 140666291201611 0 0 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29141] ppid=29135 vsize=1030820 CPUtime=0
/proc/29138/task/29141/stat : 29141 (java) S 29135 29135 32685 0 -1 4202560 16 0 0 0 0 0 0 0 20 0 11 0 42838321 1055559680 157961 18446744073709551615 4194304 4228012 140737203458224 140666189305872 140666291200724 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29142] ppid=29135 vsize=1030820 CPUtime=0
/proc/29138/task/29142/stat : 29142 (java) S 29135 29135 32685 0 -1 4202560 9 0 0 0 0 0 0 0 20 0 11 0 42838321 1055559680 157961 18446744073709551615 4194304 4228012 140737203458224 140666188253088 140666291200724 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29143] ppid=29135 vsize=1030820 CPUtime=0
/proc/29138/task/29143/stat : 29143 (java) S 29135 29135 32685 0 -1 4202560 1 0 0 0 0 0 0 0 20 0 11 0 42838324 1055559680 157961 18446744073709551615 4194304 4228012 140737203458224 140666187201520 140666291209248 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29144] ppid=29135 vsize=1030820 CPUtime=2.07
/proc/29138/task/29144/stat : 29144 (java) S 29135 29135 32685 0 -1 4202560 12683 0 0 0 201 6 0 0 20 0 11 0 42838324 1055559680 157961 18446744073709551615 4194304 4228012 140737203458224 140666186148880 140666291200724 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29145] ppid=29135 vsize=1030820 CPUtime=2.11
/proc/29138/task/29145/stat : 29145 (java) S 29135 29135 32685 0 -1 4202560 9176 0 0 0 210 1 0 0 20 0 11 0 42838324 1055559680 157961 18446744073709551615 4194304 4228012 140737203458224 140666185096208 140666291200724 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29146] ppid=29135 vsize=1030820 CPUtime=0
/proc/29138/task/29146/stat : 29146 (java) S 29135 29135 32685 0 -1 4202560 0 0 0 0 0 0 0 0 20 0 11 0 42838324 1055559680 157961 18446744073709551615 4194304 4228012 140737203458224 140666184043728 140666291200724 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29147] ppid=29135 vsize=1030820 CPUtime=0.14
/proc/29138/task/29147/stat : 29147 (java) S 29135 29135 32685 0 -1 4202560 24 0 0 0 4 10 0 0 20 0 11 0 42838324 1055559680 157961 18446744073709551615 4194304 4228012 140737203458224 140666182991232 140666291201611 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29148] ppid=29135 vsize=1030820 CPUtime=0
/proc/29138/task/29148/stat : 29148 (java) S 29135 29135 32685 0 -1 4202560 6 0 0 0 0 0 0 0 20 0 11 0 42839435 1055559680 157961 18446744073709551615 4194304 4228012 140737203458224 140666181789536 140666291201611 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
Current children cumulated CPU time (s) 285.41
Current children cumulated vsize (KiB) 1039988

[startup+296.801 s]
/proc/loadavg: 1.04 1.06 1.04 2/68 29508
/proc/meminfo: memFree=10104/1022884 swapFree=0/0
[pid=29135] ppid=29134 vsize=9168 CPUtime=0
/proc/29135/stat : 29135 (p2cudf-full-1.1) S 29134 29135 32685 0 -1 4202496 454 290 2 1 0 0 0 0 20 0 1 0 42838304 9388032 331 18446744073709551615 4194304 5129932 140737433165920 140737433164064 139788051719262 0 65536 16781316 65538 0 0 0 17 0 0 0 2 0 0
/proc/29135/statm: 2292 331 280 229 0 52 0
[pid=29138] ppid=29135 vsize=1031848 CPUtime=285.76
/proc/29138/stat : 29138 (java) S 29135 29135 32685 0 -1 4202496 171770 0 19 0 28508 68 0 0 20 0 11 0 42838309 1056612352 157973 18446744073709551615 4194304 4228012 140737203458224 140737203449248 140666291187317 0 0 0 16800975 18446744073709551615 0 0 17 0 0 0 4 0 0
/proc/29138/statm: 257962 157973 2381 9 0 245312 0
[pid=29138/tid=29139] ppid=29135 vsize=1031848 CPUtime=262.45
/proc/29138/task/29139/stat : 29139 (java) S 29135 29135 32685 0 -1 4202560 47796 0 7 0 26216 29 0 0 20 0 11 0 42838315 1056612352 157973 18446744073709551615 4194304 4228012 140737203458224 140666297721776 140666291200724 0 4 0 16800975 0 0 0 -1 0 0 0 8 0 0
[pid=29138/tid=29140] ppid=29135 vsize=1031848 CPUtime=18.92
/proc/29138/task/29140/stat : 29140 (java) S 29135 29135 32685 0 -1 4202560 100797 0 0 0 1862 30 0 0 20 0 11 0 42838320 1056612352 157973 18446744073709551615 4194304 4228012 140737203458224 140666190359680 140666291201611 0 0 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29141] ppid=29135 vsize=1031848 CPUtime=0
/proc/29138/task/29141/stat : 29141 (java) S 29135 29135 32685 0 -1 4202560 16 0 0 0 0 0 0 0 20 0 11 0 42838321 1056612352 157973 18446744073709551615 4194304 4228012 140737203458224 140666189305872 140666291200724 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29142] ppid=29135 vsize=1031848 CPUtime=0
/proc/29138/task/29142/stat : 29142 (java) S 29135 29135 32685 0 -1 4202560 9 0 0 0 0 0 0 0 20 0 11 0 42838321 1056612352 157973 18446744073709551615 4194304 4228012 140737203458224 140666188253088 140666291200724 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29143] ppid=29135 vsize=1031848 CPUtime=0
/proc/29138/task/29143/stat : 29143 (java) S 29135 29135 32685 0 -1 4202560 1 0 0 0 0 0 0 0 20 0 11 0 42838324 1056612352 157973 18446744073709551615 4194304 4228012 140737203458224 140666187201520 140666291209248 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29144] ppid=29135 vsize=1031848 CPUtime=2.07
/proc/29138/task/29144/stat : 29144 (java) S 29135 29135 32685 0 -1 4202560 12683 0 0 0 201 6 0 0 20 0 11 0 42838324 1056612352 157973 18446744073709551615 4194304 4228012 140737203458224 140666186148880 140666291200724 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29145] ppid=29135 vsize=1031848 CPUtime=2.14
/proc/29138/task/29145/stat : 29145 (java) S 29135 29135 32685 0 -1 4202560 9176 0 0 0 213 1 0 0 20 0 11 0 42838324 1056612352 157973 18446744073709551615 4194304 4228012 140737203458224 140666185096208 140666291200724 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29146] ppid=29135 vsize=1031848 CPUtime=0
/proc/29138/task/29146/stat : 29146 (java) S 29135 29135 32685 0 -1 4202560 0 0 0 0 0 0 0 0 20 0 11 0 42838324 1056612352 157973 18446744073709551615 4194304 4228012 140737203458224 140666184043728 140666291200724 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
[pid=29138/tid=29147] ppid=29135 vsize=1031848 CPUtime=0.14
/proc/29138/task/29147/stat : 29147 (java) S 29135 29135 32685 0 -1 4202560 24 0 0 0 4 10 0 0 20 0 11 0 42838324 1056612352 157973 18446744073709551615 4194304 4228012 140737203458224 140666182991232 140666291201611 0 4 0 16800975 0 0 0 -1 0 0 0 0 0 0
Current children cumulated CPU time (s) 285.76
Current children cumulated vsize (KiB) 1041016

[startup+297.001 s]
/proc/loadavg: 1.04 1.06 1.04 1/59 29509
/proc/meminfo: memFree=633776/1022884 swapFree=0/0
[pid=29135] ppid=29134 vsize=9168 CPUtime=0
/proc/29135/stat : 29135 (p2cudf-full-1.1) S 29134 29135 32685 0 -1 4202496 454 290 2 1 0 0 0 0 20 0 1 0 42838304 9388032 331 18446744073709551615 4194304 5129932 140737433165920 140737433164064 139788051719262 0 65536 16781316 65538 0 0 0 17 0 0 0 2 0 0
/proc/29135/statm: 2292 331 280 229 0 52 0
[pid=29138] ppid=29135 vsize=0 CPUtime=285.89
/proc/29138/stat : 29138 (java) Z 29135 29135 32685 0 -1 4203532 171783 0 19 0 28517 72 0 0 20 0 2 0 42838309 0 0 18446744073709551615 0 0 0 0 0 0 0 0 16800975 18446744073709551615 0 0 17 0 0 0 4 0 0
/proc/29138/statm: 0 0 0 0 0 0 0
[pid=29138/tid=29509] ppid=29135 vsize=0 CPUtime=0.11
/proc/29138/task/29509/stat : 29509 (java) D 29135 29135 32685 0 -1 4203588 9 0 0 0 6 5 0 0 20 0 2 0 42867941 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) 285.89
Current children cumulated vsize (KiB) 9168

Child status: 0
Real time (s): 297.01
CPU time (s): 285.91
CPU user time (s): 285.182
CPU system time (s): 0.728045
CPU usage (%): 96.2626
Max. virtual memory (cumulated for all children) (KiB): 1068904

getrusage(RUSAGE_CHILDREN,...) data:
user time used= 285.182
system time used= 0.728045
maximum resident set size= 631936
integral shared memory size= 0
integral unshared data size= 0
integral unshared stack size= 0
page reclaims= 172540
page faults= 22
swaps= 0
block input operations= 70784
block output operations= 536
messages sent= 0
messages received= 0
signals received= 0
voluntary context switches= 7333
involuntary context switches= 17093

runsolver used 0.720045 second user time and 1.83211 second system time

The end