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: /home/misc2010/bin/runsolver -s SIGUSR1 -M 1124 -C 290 -d 10 -w /home/misc2010/tmp/201108300820/p2cudf-user-1.13/adf7b774-9af8-11df-bc37-00163e46d37a.cudf.dudf-real.log.runsolver ./p2cudf-user-1.13 /home/misc2010/data/2011/dudf-real//adf7b774-9af8-11df-bc37-00163e46d37a.cudf /home/misc2010/tmp/201108300820/p2cudf-user-1.13/adf7b774-9af8-11df-bc37-00163e46d37a.cudf.dudf-real.result +sum(installedsize) 

Enforcing CPUTime limit (soft limit, will send signal-name then SIGKILL): 290 seconds
Enforcing CPUTime limit (hard limit, will send SIGXCPU): 320 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: 0.85 0.97 0.99 1/35 14796
/proc/meminfo: memFree=939092/1048576 swapFree=0/0
[pid=14796] ppid=14795 vsize=3024 CPUtime=0
/proc/14796/stat : 14796 (runsolver) D 14795 14796 2160 34817 2160 4202560 73 0 0 0 0 0 0 0 25 0 1 0 57584576 3096576 94 1283457024 134512640 134586868 4289901616 18446744073709551615 4294960130 0 0 0 24578 18446744071564332000 0 0 17 0 0 0 0
/proc/14796/statm: 756 94 62 19 0 55 0

[startup+0.206326 s]
/proc/loadavg: 0.85 0.97 0.99 1/35 14796
/proc/meminfo: memFree=939092/1048576 swapFree=0/0
[pid=14796] ppid=14795 vsize=2568 CPUtime=0
/proc/14796/stat : 14796 (p2cudf-user-1.1) S 14795 14796 2160 34817 2160 4202496 374 0 0 0 0 0 0 0 25 0 1 0 57584576 2629632 270 1283457024 134512640 135304128 4289633472 18446744073709551615 4294960130 0 65536 4 65538 18446744071564329979 0 0 17 0 0 0 0
/proc/14796/statm: 642 270 230 194 0 29 0
Current children cumulated CPU time (s) 0
Current children cumulated vsize (KiB) 2568

[startup+0.30629 s]
/proc/loadavg: 0.85 0.97 0.99 1/35 14796
/proc/meminfo: memFree=939092/1048576 swapFree=0/0
[pid=14796] ppid=14795 vsize=2568 CPUtime=0
/proc/14796/stat : 14796 (p2cudf-user-1.1) S 14795 14796 2160 34817 2160 4202496 374 0 0 0 0 0 0 0 25 0 1 0 57584576 2629632 270 1283457024 134512640 135304128 4289633472 18446744073709551615 4294960130 0 65536 4 65538 18446744071564329979 0 0 17 0 0 0 0
/proc/14796/statm: 642 270 230 194 0 29 0
Current children cumulated CPU time (s) 0
Current children cumulated vsize (KiB) 2568

[startup+0.406307 s]
/proc/loadavg: 0.85 0.97 0.99 1/35 14796
/proc/meminfo: memFree=939092/1048576 swapFree=0/0
[pid=14796] ppid=14795 vsize=2568 CPUtime=0
/proc/14796/stat : 14796 (p2cudf-user-1.1) S 14795 14796 2160 34817 2160 4202496 374 0 0 0 0 0 0 0 25 0 1 0 57584576 2629632 270 1283457024 134512640 135304128 4289633472 18446744073709551615 4294960130 0 65536 4 65538 18446744071564329979 0 0 17 0 0 0 0
/proc/14796/statm: 642 270 230 194 0 29 0
Current children cumulated CPU time (s) 0
Current children cumulated vsize (KiB) 2568

[startup+0.706406 s]
/proc/loadavg: 0.85 0.97 0.99 1/35 14796
/proc/meminfo: memFree=939092/1048576 swapFree=0/0
[pid=14796] ppid=14795 vsize=2568 CPUtime=0
/proc/14796/stat : 14796 (p2cudf-user-1.1) S 14795 14796 2160 34817 2160 4202496 374 0 0 0 0 0 0 0 25 0 1 0 57584576 2629632 270 1283457024 134512640 135304128 4289633472 18446744073709551615 4294960130 0 65536 4 65538 18446744071564329979 0 0 17 0 0 0 0
/proc/14796/statm: 642 270 230 194 0 29 0
Current children cumulated CPU time (s) 0
Current children cumulated vsize (KiB) 2568

[startup+1.50781 s]
/proc/loadavg: 0.86 0.97 0.99 4/47 14819
/proc/meminfo: memFree=901596/1048576 swapFree=0/0
[pid=14796] ppid=14795 vsize=2568 CPUtime=0
/proc/14796/stat : 14796 (p2cudf-user-1.1) S 14795 14796 2160 34817 2160 4202496 374 0 0 0 0 0 0 0 25 0 1 0 57584576 2629632 270 1283457024 134512640 135304128 4289633472 18446744073709551615 4294960130 0 65536 4 65538 18446744071564329979 0 0 17 0 0 0 0
/proc/14796/statm: 642 270 230 194 0 29 0
[pid=14798] ppid=14796 vsize=2568 CPUtime=0.02
/proc/14798/stat : 14798 (p2cudf) S 14796 14796 2160 34817 2160 4202496 387 3014 0 1 0 0 2 0 25 0 1 0 57584577 2629632 279 1283457024 134512640 135304128 4290547136 18446744073709551615 4294960130 0 65536 4 65538 18446744071564329979 0 0 17 0 0 0 0
/proc/14798/statm: 642 279 239 194 0 29 0
[pid=14810] ppid=14798 vsize=882888 CPUtime=0.79
/proc/14810/stat : 14810 (java) S 14798 14796 2160 34817 2160 4202496 15468 0 105 0 77 2 0 0 23 0 10 0 57584580 904077312 13331 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 0 0 16800975 18446744073709551615 0 0 17 0 0 0 0
/proc/14810/statm: 220722 13331 1742 10 0 217813 0
[pid=14810/tid=14811] ppid=14798 vsize=882888 CPUtime=0.29
/proc/14810/task/14811/stat : 14811 (java) R 14798 14796 2160 34817 2160 4202560 5696 0 15 0 28 1 0 0 25 0 10 0 57584607 904077312 13331 1283457024 134512640 134550932 4290911424 18446744073709551615 4095025299 0 4 0 16800975 0 0 0 -1 0 0 0 0
[pid=14810/tid=14812] ppid=14798 vsize=882888 CPUtime=0
/proc/14810/task/14812/stat : 14812 (java) S 14798 14796 2160 34817 2160 4202560 6 0 0 0 0 0 0 0 19 0 10 0 57584617 904077312 13331 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 0 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14813] ppid=14798 vsize=882888 CPUtime=0
/proc/14810/task/14813/stat : 14813 (java) S 14798 14796 2160 34817 2160 4202560 7 0 1 0 0 0 0 0 25 0 10 0 57584617 904077312 13331 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14814] ppid=14798 vsize=882888 CPUtime=0
/proc/14810/task/14814/stat : 14814 (java) S 14798 14796 2160 34817 2160 4202560 4 0 0 0 0 0 0 0 25 0 10 0 57584618 904077312 13331 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14815] ppid=14798 vsize=882888 CPUtime=0
/proc/14810/task/14815/stat : 14815 (java) S 14798 14796 2160 34817 2160 4202560 1 0 0 0 0 0 0 0 25 0 10 0 57584628 904077312 13331 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14816] ppid=14798 vsize=882888 CPUtime=0.36
/proc/14810/task/14816/stat : 14816 (java) R 14798 14796 2160 34817 2160 4202560 6714 0 1 0 36 0 0 0 23 0 10 0 57584628 904077312 13331 1283457024 134512640 134550932 4290911424 18446744073709551615 4151248702 0 4 0 16800975 0 0 0 -1 0 0 0 0
[pid=14810/tid=14817] ppid=14798 vsize=882888 CPUtime=0.12
/proc/14810/task/14817/stat : 14817 (java) S 14798 14796 2160 34817 2160 4202560 2061 0 7 0 12 0 0 0 23 0 10 0 57584628 904077312 13331 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14818] ppid=14798 vsize=882888 CPUtime=0
/proc/14810/task/14818/stat : 14818 (java) S 14798 14796 2160 34817 2160 4202560 1 0 0 0 0 0 0 0 25 0 10 0 57584628 904077312 13331 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14819] ppid=14798 vsize=882888 CPUtime=0
/proc/14810/task/14819/stat : 14819 (java) S 14798 14796 2160 34817 2160 4202560 2 0 0 0 0 0 0 0 16 0 10 0 57584628 904077312 13331 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
Current children cumulated CPU time (s) 0.81
Current children cumulated vsize (KiB) 888024

[startup+3.10363 s]
/proc/loadavg: 0.86 0.97 0.99 2/47 14820
/proc/meminfo: memFree=788508/1048576 swapFree=0/0
[pid=14796] ppid=14795 vsize=2568 CPUtime=0
/proc/14796/stat : 14796 (p2cudf-user-1.1) S 14795 14796 2160 34817 2160 4202496 374 0 0 0 0 0 0 0 25 0 1 0 57584576 2629632 270 1283457024 134512640 135304128 4289633472 18446744073709551615 4294960130 0 65536 4 65538 18446744071564329979 0 0 17 0 0 0 0
/proc/14796/statm: 642 270 230 194 0 29 0
[pid=14798] ppid=14796 vsize=2568 CPUtime=0.02
/proc/14798/stat : 14798 (p2cudf) S 14796 14796 2160 34817 2160 4202496 387 3014 0 1 0 0 2 0 25 0 1 0 57584577 2629632 279 1283457024 134512640 135304128 4290547136 18446744073709551615 4294960130 0 65536 4 65538 18446744071564329979 0 0 17 0 0 0 0
/proc/14798/statm: 642 279 239 194 0 29 0
[pid=14810] ppid=14798 vsize=882888 CPUtime=2.34
/proc/14810/stat : 14810 (java) S 14798 14796 2160 34817 2160 4202496 60725 0 105 0 215 19 0 0 23 0 10 0 57584580 904077312 57092 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 0 0 16800975 18446744073709551615 0 0 17 0 0 0 0
/proc/14810/statm: 220722 57092 1751 10 0 217813 0
[pid=14810/tid=14811] ppid=14798 vsize=882888 CPUtime=1.32
/proc/14810/task/14811/stat : 14811 (java) R 14798 14796 2160 34817 2160 4202560 48978 0 15 0 116 16 0 0 25 0 10 0 57584607 904077312 57092 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 0 0 0 -1 0 0 0 0
[pid=14810/tid=14812] ppid=14798 vsize=882888 CPUtime=0
/proc/14810/task/14812/stat : 14812 (java) S 14798 14796 2160 34817 2160 4202560 6 0 0 0 0 0 0 0 18 0 10 0 57584617 904077312 57092 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 0 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14813] ppid=14798 vsize=882888 CPUtime=0
/proc/14810/task/14813/stat : 14813 (java) S 14798 14796 2160 34817 2160 4202560 7 0 1 0 0 0 0 0 25 0 10 0 57584617 904077312 57092 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14814] ppid=14798 vsize=882888 CPUtime=0
/proc/14810/task/14814/stat : 14814 (java) S 14798 14796 2160 34817 2160 4202560 4 0 0 0 0 0 0 0 25 0 10 0 57584618 904077312 57092 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14815] ppid=14798 vsize=882888 CPUtime=0
/proc/14810/task/14815/stat : 14815 (java) S 14798 14796 2160 34817 2160 4202560 1 0 0 0 0 0 0 0 25 0 10 0 57584628 904077312 57092 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14816] ppid=14798 vsize=882888 CPUtime=0.86
/proc/14810/task/14816/stat : 14816 (java) R 14798 14796 2160 34817 2160 4202560 8689 0 1 0 84 2 0 0 16 0 10 0 57584628 904077312 57092 1283457024 134512640 134550932 4290911424 18446744073709551615 4148517879 0 4 0 16800975 0 0 0 -1 0 0 0 0
[pid=14810/tid=14817] ppid=14798 vsize=882888 CPUtime=0.15
/proc/14810/task/14817/stat : 14817 (java) S 14798 14796 2160 34817 2160 4202560 2061 0 7 0 15 0 0 0 15 0 10 0 57584628 904077312 57092 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14818] ppid=14798 vsize=882888 CPUtime=0
/proc/14810/task/14818/stat : 14818 (java) S 14798 14796 2160 34817 2160 4202560 1 0 0 0 0 0 0 0 25 0 10 0 57584628 904077312 57092 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14819] ppid=14798 vsize=882888 CPUtime=0
/proc/14810/task/14819/stat : 14819 (java) S 14798 14796 2160 34817 2160 4202560 2 0 0 0 0 0 0 0 15 0 10 0 57584628 904077312 57092 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
Current children cumulated CPU time (s) 2.36
Current children cumulated vsize (KiB) 888024
heavy processes:

[startup+6.30486 s]
/proc/loadavg: 0.95 0.98 0.99 2/48 14821
/proc/meminfo: memFree=652008/1048576 swapFree=0/0
[pid=14796] ppid=14795 vsize=2568 CPUtime=0
/proc/14796/stat : 14796 (p2cudf-user-1.1) S 14795 14796 2160 34817 2160 4202496 374 0 0 0 0 0 0 0 25 0 1 0 57584576 2629632 270 1283457024 134512640 135304128 4289633472 18446744073709551615 4294960130 0 65536 4 65538 18446744071564329979 0 0 17 0 0 0 0
/proc/14796/statm: 642 270 230 194 0 29 0
[pid=14798] ppid=14796 vsize=2568 CPUtime=0.02
/proc/14798/stat : 14798 (p2cudf) S 14796 14796 2160 34817 2160 4202496 387 3014 0 1 0 0 2 0 25 0 1 0 57584577 2629632 279 1283457024 134512640 135304128 4290547136 18446744073709551615 4294960130 0 65536 4 65538 18446744071564329979 0 0 17 0 0 0 0
/proc/14798/statm: 642 279 239 194 0 29 0
[pid=14810] ppid=14798 vsize=883592 CPUtime=5.44
/proc/14810/stat : 14810 (java) S 14798 14796 2160 34817 2160 4202496 75449 0 105 0 521 23 0 0 23 0 11 0 57584580 904798208 70741 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 0 0 16800975 18446744073709551615 0 0 17 0 0 0 0
/proc/14810/statm: 220898 70741 1774 10 0 217989 0
[pid=14810/tid=14811] ppid=14798 vsize=883592 CPUtime=2.88
/proc/14810/task/14811/stat : 14811 (java) R 14798 14796 2160 34817 2160 4202560 50273 0 15 0 270 18 0 0 25 0 11 0 57584607 904798208 70741 1283457024 134512640 134550932 4290911424 18446744073709551615 4095378060 0 4 0 16800975 0 0 0 -1 0 0 0 0
[pid=14810/tid=14812] ppid=14798 vsize=883592 CPUtime=0.29
/proc/14810/task/14812/stat : 14812 (java) S 14798 14796 2160 34817 2160 4202560 12145 0 0 0 27 2 0 0 16 0 11 0 57584617 904798208 70741 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 0 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14813] ppid=14798 vsize=883592 CPUtime=0
/proc/14810/task/14813/stat : 14813 (java) S 14798 14796 2160 34817 2160 4202560 8 0 1 0 0 0 0 0 18 0 11 0 57584617 904798208 70741 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14814] ppid=14798 vsize=883592 CPUtime=0
/proc/14810/task/14814/stat : 14814 (java) S 14798 14796 2160 34817 2160 4202560 6 0 0 0 0 0 0 0 18 0 11 0 57584618 904798208 70741 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14815] ppid=14798 vsize=883592 CPUtime=0
/proc/14810/task/14815/stat : 14815 (java) S 14798 14796 2160 34817 2160 4202560 1 0 0 0 0 0 0 0 25 0 11 0 57584628 904798208 70741 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14816] ppid=14798 vsize=883592 CPUtime=2.1
/proc/14810/task/14816/stat : 14816 (java) S 14798 14796 2160 34817 2160 4202560 9972 0 1 0 208 2 0 0 15 0 11 0 57584628 904798208 70741 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14817] ppid=14798 vsize=883592 CPUtime=0.15
/proc/14810/task/14817/stat : 14817 (java) S 14798 14796 2160 34817 2160 4202560 2061 0 7 0 15 0 0 0 15 0 11 0 57584628 904798208 70741 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14818] ppid=14798 vsize=883592 CPUtime=0
/proc/14810/task/14818/stat : 14818 (java) S 14798 14796 2160 34817 2160 4202560 1 0 0 0 0 0 0 0 25 0 11 0 57584628 904798208 70741 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14819] ppid=14798 vsize=883592 CPUtime=0
/proc/14810/task/14819/stat : 14819 (java) S 14798 14796 2160 34817 2160 4202560 2 0 0 0 0 0 0 0 15 0 11 0 57584628 904798208 70741 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14821] ppid=14798 vsize=883592 CPUtime=0
/proc/14810/task/14821/stat : 14821 (java) S 14798 14796 2160 34817 2160 4202560 4 0 0 0 0 0 0 0 25 0 11 0 57585030 904798208 70741 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
Current children cumulated CPU time (s) 5.46
Current children cumulated vsize (KiB) 888728

[startup+12.7058 s]
/proc/loadavg: 1.03 1.00 1.00 3/48 14822
/proc/meminfo: memFree=615676/1048576 swapFree=0/0
[pid=14796] ppid=14795 vsize=2568 CPUtime=0
/proc/14796/stat : 14796 (p2cudf-user-1.1) S 14795 14796 2160 34817 2160 4202496 374 0 0 0 0 0 0 0 25 0 1 0 57584576 2629632 270 1283457024 134512640 135304128 4289633472 18446744073709551615 4294960130 0 65536 4 65538 18446744071564329979 0 0 17 0 0 0 0
/proc/14796/statm: 642 270 230 194 0 29 0
[pid=14798] ppid=14796 vsize=2568 CPUtime=0.02
/proc/14798/stat : 14798 (p2cudf) S 14796 14796 2160 34817 2160 4202496 387 3014 0 1 0 0 2 0 25 0 1 0 57584577 2629632 279 1283457024 134512640 135304128 4290547136 18446744073709551615 4294960130 0 65536 4 65538 18446744071564329979 0 0 17 0 0 0 0
/proc/14798/statm: 642 279 239 194 0 29 0
[pid=14810] ppid=14798 vsize=883592 CPUtime=11.84
/proc/14810/stat : 14810 (java) S 14798 14796 2160 34817 2160 4202496 84487 0 105 0 1156 28 0 0 23 0 11 0 57584580 904798208 79779 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 0 0 16800975 18446744073709551615 0 0 17 0 0 0 0
/proc/14810/statm: 220898 79779 1783 10 0 217989 0
[pid=14810/tid=14811] ppid=14798 vsize=883592 CPUtime=8.15
/proc/14810/task/14811/stat : 14811 (java) R 14798 14796 2160 34817 2160 4202560 50274 0 15 0 797 18 0 0 25 0 11 0 57584607 904798208 79779 1283457024 134512640 134550932 4290911424 18446744073709551615 4095664191 0 4 0 16800975 0 0 0 -1 0 0 0 0
[pid=14810/tid=14812] ppid=14798 vsize=883592 CPUtime=1.25
/proc/14810/task/14812/stat : 14812 (java) S 14798 14796 2160 34817 2160 4202560 21151 0 0 0 118 7 0 0 16 0 11 0 57584617 904798208 79779 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 0 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14813] ppid=14798 vsize=883592 CPUtime=0
/proc/14810/task/14813/stat : 14813 (java) S 14798 14796 2160 34817 2160 4202560 8 0 1 0 0 0 0 0 18 0 11 0 57584617 904798208 79779 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14814] ppid=14798 vsize=883592 CPUtime=0
/proc/14810/task/14814/stat : 14814 (java) S 14798 14796 2160 34817 2160 4202560 6 0 0 0 0 0 0 0 18 0 11 0 57584618 904798208 79779 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14815] ppid=14798 vsize=883592 CPUtime=0
/proc/14810/task/14815/stat : 14815 (java) S 14798 14796 2160 34817 2160 4202560 1 0 0 0 0 0 0 0 25 0 11 0 57584628 904798208 79779 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14816] ppid=14798 vsize=883592 CPUtime=2.27
/proc/14810/task/14816/stat : 14816 (java) S 14798 14796 2160 34817 2160 4202560 10003 0 1 0 225 2 0 0 15 0 11 0 57584628 904798208 79779 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14817] ppid=14798 vsize=883592 CPUtime=0.15
/proc/14810/task/14817/stat : 14817 (java) S 14798 14796 2160 34817 2160 4202560 2061 0 7 0 15 0 0 0 15 0 11 0 57584628 904798208 79779 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14818] ppid=14798 vsize=883592 CPUtime=0
/proc/14810/task/14818/stat : 14818 (java) S 14798 14796 2160 34817 2160 4202560 1 0 0 0 0 0 0 0 25 0 11 0 57584628 904798208 79779 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14819] ppid=14798 vsize=883592 CPUtime=0
/proc/14810/task/14819/stat : 14819 (java) S 14798 14796 2160 34817 2160 4202560 2 0 0 0 0 0 0 0 15 0 11 0 57584628 904798208 79779 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14821] ppid=14798 vsize=883592 CPUtime=0
/proc/14810/task/14821/stat : 14821 (java) S 14798 14796 2160 34817 2160 4202560 4 0 0 0 0 0 0 0 25 0 11 0 57585030 904798208 79779 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
Current children cumulated CPU time (s) 11.86
Current children cumulated vsize (KiB) 888728

[startup+25.5112 s]
/proc/loadavg: 1.03 1.00 1.00 2/48 14823
/proc/meminfo: memFree=613692/1048576 swapFree=0/0
[pid=14796] ppid=14795 vsize=2568 CPUtime=0
/proc/14796/stat : 14796 (p2cudf-user-1.1) S 14795 14796 2160 34817 2160 4202496 374 0 0 0 0 0 0 0 25 0 1 0 57584576 2629632 270 1283457024 134512640 135304128 4289633472 18446744073709551615 4294960130 0 65536 4 65538 18446744071564329979 0 0 17 0 0 0 0
/proc/14796/statm: 642 270 230 194 0 29 0
[pid=14798] ppid=14796 vsize=2568 CPUtime=0.02
/proc/14798/stat : 14798 (p2cudf) S 14796 14796 2160 34817 2160 4202496 387 3014 0 1 0 0 2 0 25 0 1 0 57584577 2629632 279 1283457024 134512640 135304128 4290547136 18446744073709551615 4294960130 0 65536 4 65538 18446744071564329979 0 0 17 0 0 0 0
/proc/14798/statm: 642 279 239 194 0 29 0
[pid=14810] ppid=14798 vsize=883592 CPUtime=24.63
/proc/14810/stat : 14810 (java) S 14798 14796 2160 34817 2160 4202496 84956 0 105 0 2435 28 0 0 23 0 11 0 57584580 904798208 80248 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 0 0 16800975 18446744073709551615 0 0 17 0 0 0 0
/proc/14810/statm: 220898 80248 1783 10 0 217989 0
[pid=14810/tid=14811] ppid=14798 vsize=883592 CPUtime=20.08
/proc/14810/task/14811/stat : 14811 (java) R 14798 14796 2160 34817 2160 4202560 50274 0 15 0 1990 18 0 0 25 0 11 0 57584607 904798208 80248 1283457024 134512640 134550932 4290911424 18446744073709551615 4095584133 0 4 0 16800975 0 0 0 -1 0 0 0 0
[pid=14810/tid=14812] ppid=14798 vsize=883592 CPUtime=2.11
/proc/14810/task/14812/stat : 14812 (java) S 14798 14796 2160 34817 2160 4202560 21620 0 0 0 204 7 0 0 15 0 11 0 57584617 904798208 80248 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 0 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14813] ppid=14798 vsize=883592 CPUtime=0
/proc/14810/task/14813/stat : 14813 (java) S 14798 14796 2160 34817 2160 4202560 8 0 1 0 0 0 0 0 18 0 11 0 57584617 904798208 80248 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14814] ppid=14798 vsize=883592 CPUtime=0
/proc/14810/task/14814/stat : 14814 (java) S 14798 14796 2160 34817 2160 4202560 6 0 0 0 0 0 0 0 18 0 11 0 57584618 904798208 80248 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14815] ppid=14798 vsize=883592 CPUtime=0
/proc/14810/task/14815/stat : 14815 (java) S 14798 14796 2160 34817 2160 4202560 1 0 0 0 0 0 0 0 25 0 11 0 57584628 904798208 80248 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14816] ppid=14798 vsize=883592 CPUtime=2.27
/proc/14810/task/14816/stat : 14816 (java) S 14798 14796 2160 34817 2160 4202560 10003 0 1 0 225 2 0 0 15 0 11 0 57584628 904798208 80248 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14817] ppid=14798 vsize=883592 CPUtime=0.15
/proc/14810/task/14817/stat : 14817 (java) S 14798 14796 2160 34817 2160 4202560 2061 0 7 0 15 0 0 0 15 0 11 0 57584628 904798208 80248 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14818] ppid=14798 vsize=883592 CPUtime=0
/proc/14810/task/14818/stat : 14818 (java) S 14798 14796 2160 34817 2160 4202560 1 0 0 0 0 0 0 0 25 0 11 0 57584628 904798208 80248 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14819] ppid=14798 vsize=883592 CPUtime=0
/proc/14810/task/14819/stat : 14819 (java) R 14798 14796 2160 34817 2160 4202560 2 0 0 0 0 0 0 0 15 0 11 0 57584628 904798208 80248 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 0 0 0 -1 0 0 0 0
[pid=14810/tid=14821] ppid=14798 vsize=883592 CPUtime=0
/proc/14810/task/14821/stat : 14821 (java) S 14798 14796 2160 34817 2160 4202560 4 0 0 0 0 0 0 0 25 0 11 0 57585030 904798208 80248 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
Current children cumulated CPU time (s) 24.65
Current children cumulated vsize (KiB) 888728

[startup+51.1072 s]
/proc/loadavg: 1.02 1.00 1.00 2/47 14824
/proc/meminfo: memFree=601060/1048576 swapFree=0/0
[pid=14796] ppid=14795 vsize=2568 CPUtime=0
/proc/14796/stat : 14796 (p2cudf-user-1.1) S 14795 14796 2160 34817 2160 4202496 374 0 0 0 0 0 0 0 25 0 1 0 57584576 2629632 270 1283457024 134512640 135304128 4289633472 18446744073709551615 4294960130 0 65536 4 65538 18446744071564329979 0 0 17 0 0 0 0
/proc/14796/statm: 642 270 230 194 0 29 0
[pid=14798] ppid=14796 vsize=2568 CPUtime=0.02
/proc/14798/stat : 14798 (p2cudf) S 14796 14796 2160 34817 2160 4202496 387 3014 0 1 0 0 2 0 25 0 1 0 57584577 2629632 279 1283457024 134512640 135304128 4290547136 18446744073709551615 4294960130 0 65536 4 65538 18446744071564329979 0 0 17 0 0 0 0
/proc/14798/statm: 642 279 239 194 0 29 0
[pid=14810] ppid=14798 vsize=883592 CPUtime=50.22
/proc/14810/stat : 14810 (java) S 14798 14796 2160 34817 2160 4202496 88123 0 105 0 4994 28 0 0 23 0 11 0 57584580 904798208 83415 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 0 0 16800975 18446744073709551615 0 0 17 0 0 0 0
/proc/14810/statm: 220898 83415 1783 10 0 217989 0
[pid=14810/tid=14811] ppid=14798 vsize=883592 CPUtime=44.13
/proc/14810/task/14811/stat : 14811 (java) R 14798 14796 2160 34817 2160 4202560 50274 0 15 0 4395 18 0 0 25 0 11 0 57584607 904798208 83415 1283457024 134512640 134550932 4290911424 18446744073709551615 4095806207 0 4 0 16800975 0 0 0 -1 0 0 0 0
[pid=14810/tid=14812] ppid=14798 vsize=883592 CPUtime=3.64
/proc/14810/task/14812/stat : 14812 (java) S 14798 14796 2160 34817 2160 4202560 24787 0 0 0 357 7 0 0 15 0 11 0 57584617 904798208 83415 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 0 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14813] ppid=14798 vsize=883592 CPUtime=0
/proc/14810/task/14813/stat : 14813 (java) S 14798 14796 2160 34817 2160 4202560 8 0 1 0 0 0 0 0 18 0 11 0 57584617 904798208 83415 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14814] ppid=14798 vsize=883592 CPUtime=0
/proc/14810/task/14814/stat : 14814 (java) S 14798 14796 2160 34817 2160 4202560 6 0 0 0 0 0 0 0 18 0 11 0 57584618 904798208 83415 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14815] ppid=14798 vsize=883592 CPUtime=0
/proc/14810/task/14815/stat : 14815 (java) S 14798 14796 2160 34817 2160 4202560 1 0 0 0 0 0 0 0 25 0 11 0 57584628 904798208 83415 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14816] ppid=14798 vsize=883592 CPUtime=2.27
/proc/14810/task/14816/stat : 14816 (java) S 14798 14796 2160 34817 2160 4202560 10003 0 1 0 225 2 0 0 15 0 11 0 57584628 904798208 83415 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14817] ppid=14798 vsize=883592 CPUtime=0.15
/proc/14810/task/14817/stat : 14817 (java) S 14798 14796 2160 34817 2160 4202560 2061 0 7 0 15 0 0 0 15 0 11 0 57584628 904798208 83415 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14818] ppid=14798 vsize=883592 CPUtime=0
/proc/14810/task/14818/stat : 14818 (java) S 14798 14796 2160 34817 2160 4202560 1 0 0 0 0 0 0 0 25 0 11 0 57584628 904798208 83415 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14819] ppid=14798 vsize=883592 CPUtime=0
/proc/14810/task/14819/stat : 14819 (java) S 14798 14796 2160 34817 2160 4202560 2 0 0 0 0 0 0 0 15 0 11 0 57584628 904798208 83415 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14821] ppid=14798 vsize=883592 CPUtime=0
/proc/14810/task/14821/stat : 14821 (java) S 14798 14796 2160 34817 2160 4202560 4 0 0 0 0 0 0 0 25 0 11 0 57585030 904798208 83415 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
Current children cumulated CPU time (s) 50.24
Current children cumulated vsize (KiB) 888728

[startup+102.313 s]
/proc/loadavg: 1.04 1.01 1.00 2/46 14824
/proc/meminfo: memFree=593008/1048576 swapFree=0/0
[pid=14796] ppid=14795 vsize=2568 CPUtime=0
/proc/14796/stat : 14796 (p2cudf-user-1.1) S 14795 14796 2160 34817 2160 4202496 374 0 0 0 0 0 0 0 25 0 1 0 57584576 2629632 270 1283457024 134512640 135304128 4289633472 18446744073709551615 4294960130 0 65536 4 65538 18446744071564329979 0 0 17 0 0 0 0
/proc/14796/statm: 642 270 230 194 0 29 0
[pid=14798] ppid=14796 vsize=2568 CPUtime=0.02
/proc/14798/stat : 14798 (p2cudf) S 14796 14796 2160 34817 2160 4202496 387 3014 0 1 0 0 2 0 25 0 1 0 57584577 2629632 279 1283457024 134512640 135304128 4290547136 18446744073709551615 4294960130 0 65536 4 65538 18446744071564329979 0 0 17 0 0 0 0
/proc/14798/statm: 642 279 239 194 0 29 0
[pid=14810] ppid=14798 vsize=883592 CPUtime=101.42
/proc/14810/stat : 14810 (java) S 14798 14796 2160 34817 2160 4202496 90117 0 105 0 10113 29 0 0 23 0 11 0 57584580 904798208 85409 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 0 0 16800975 18446744073709551615 0 0 17 0 0 0 0
/proc/14810/statm: 220898 85409 1783 10 0 217989 0
[pid=14810/tid=14811] ppid=14798 vsize=883592 CPUtime=93.46
/proc/14810/task/14811/stat : 14811 (java) R 14798 14796 2160 34817 2160 4202560 50274 0 15 0 9328 18 0 0 25 0 11 0 57584607 904798208 85409 1283457024 134512640 134550932 4290911424 18446744073709551615 4095700916 0 4 0 16800975 0 0 0 -1 0 0 0 0
[pid=14810/tid=14812] ppid=14798 vsize=883592 CPUtime=5.5
/proc/14810/task/14812/stat : 14812 (java) S 14798 14796 2160 34817 2160 4202560 26781 0 0 0 543 7 0 0 15 0 11 0 57584617 904798208 85409 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 0 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14813] ppid=14798 vsize=883592 CPUtime=0
/proc/14810/task/14813/stat : 14813 (java) S 14798 14796 2160 34817 2160 4202560 8 0 1 0 0 0 0 0 18 0 11 0 57584617 904798208 85409 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14814] ppid=14798 vsize=883592 CPUtime=0
/proc/14810/task/14814/stat : 14814 (java) S 14798 14796 2160 34817 2160 4202560 6 0 0 0 0 0 0 0 18 0 11 0 57584618 904798208 85409 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14815] ppid=14798 vsize=883592 CPUtime=0
/proc/14810/task/14815/stat : 14815 (java) S 14798 14796 2160 34817 2160 4202560 1 0 0 0 0 0 0 0 25 0 11 0 57584628 904798208 85409 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14816] ppid=14798 vsize=883592 CPUtime=2.27
/proc/14810/task/14816/stat : 14816 (java) S 14798 14796 2160 34817 2160 4202560 10003 0 1 0 225 2 0 0 15 0 11 0 57584628 904798208 85409 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14817] ppid=14798 vsize=883592 CPUtime=0.15
/proc/14810/task/14817/stat : 14817 (java) S 14798 14796 2160 34817 2160 4202560 2061 0 7 0 15 0 0 0 15 0 11 0 57584628 904798208 85409 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14818] ppid=14798 vsize=883592 CPUtime=0
/proc/14810/task/14818/stat : 14818 (java) S 14798 14796 2160 34817 2160 4202560 1 0 0 0 0 0 0 0 25 0 11 0 57584628 904798208 85409 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14819] ppid=14798 vsize=883592 CPUtime=0
/proc/14810/task/14819/stat : 14819 (java) S 14798 14796 2160 34817 2160 4202560 2 0 0 0 0 0 0 0 15 0 11 0 57584628 904798208 85409 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14821] ppid=14798 vsize=883592 CPUtime=0
/proc/14810/task/14821/stat : 14821 (java) S 14798 14796 2160 34817 2160 4202560 4 0 0 0 0 0 0 0 25 0 11 0 57585030 904798208 85409 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
Current children cumulated CPU time (s) 101.44
Current children cumulated vsize (KiB) 888728

[startup+162.306 s]
/proc/loadavg: 1.01 1.01 1.00 2/46 14824
/proc/meminfo: memFree=585940/1048576 swapFree=0/0
[pid=14796] ppid=14795 vsize=2568 CPUtime=0
/proc/14796/stat : 14796 (p2cudf-user-1.1) S 14795 14796 2160 34817 2160 4202496 374 0 0 0 0 0 0 0 25 0 1 0 57584576 2629632 270 1283457024 134512640 135304128 4289633472 18446744073709551615 4294960130 0 65536 4 65538 18446744071564329979 0 0 17 0 0 0 0
/proc/14796/statm: 642 270 230 194 0 29 0
[pid=14798] ppid=14796 vsize=2568 CPUtime=0.02
/proc/14798/stat : 14798 (p2cudf) S 14796 14796 2160 34817 2160 4202496 387 3014 0 1 0 0 2 0 25 0 1 0 57584577 2629632 279 1283457024 134512640 135304128 4290547136 18446744073709551615 4294960130 0 65536 4 65538 18446744071564329979 0 0 17 0 0 0 0
/proc/14798/statm: 642 279 239 194 0 29 0
[pid=14810] ppid=14798 vsize=883592 CPUtime=161.36
/proc/14810/stat : 14810 (java) S 14798 14796 2160 34817 2160 4202496 91828 0 105 0 16105 31 0 0 23 0 11 0 57584580 904798208 87120 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 0 0 16800975 18446744073709551615 0 0 17 0 0 0 0
/proc/14810/statm: 220898 87120 1783 10 0 217989 0
[pid=14810/tid=14811] ppid=14798 vsize=883592 CPUtime=151.47
/proc/14810/task/14811/stat : 14811 (java) R 14798 14796 2160 34817 2160 4202560 50274 0 15 0 15127 20 0 0 25 0 11 0 57584607 904798208 87120 1283457024 134512640 134550932 4290911424 18446744073709551615 4095767362 0 4 0 16800975 0 0 0 -1 0 0 0 0
[pid=14810/tid=14812] ppid=14798 vsize=883592 CPUtime=7.44
/proc/14810/task/14812/stat : 14812 (java) S 14798 14796 2160 34817 2160 4202560 28492 0 0 0 736 8 0 0 15 0 11 0 57584617 904798208 87120 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 0 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14813] ppid=14798 vsize=883592 CPUtime=0
/proc/14810/task/14813/stat : 14813 (java) S 14798 14796 2160 34817 2160 4202560 8 0 1 0 0 0 0 0 18 0 11 0 57584617 904798208 87120 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14814] ppid=14798 vsize=883592 CPUtime=0
/proc/14810/task/14814/stat : 14814 (java) S 14798 14796 2160 34817 2160 4202560 6 0 0 0 0 0 0 0 18 0 11 0 57584618 904798208 87120 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14815] ppid=14798 vsize=883592 CPUtime=0
/proc/14810/task/14815/stat : 14815 (java) S 14798 14796 2160 34817 2160 4202560 1 0 0 0 0 0 0 0 25 0 11 0 57584628 904798208 87120 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14816] ppid=14798 vsize=883592 CPUtime=2.27
/proc/14810/task/14816/stat : 14816 (java) S 14798 14796 2160 34817 2160 4202560 10003 0 1 0 225 2 0 0 15 0 11 0 57584628 904798208 87120 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14817] ppid=14798 vsize=883592 CPUtime=0.15
/proc/14810/task/14817/stat : 14817 (java) S 14798 14796 2160 34817 2160 4202560 2061 0 7 0 15 0 0 0 15 0 11 0 57584628 904798208 87120 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14818] ppid=14798 vsize=883592 CPUtime=0
/proc/14810/task/14818/stat : 14818 (java) S 14798 14796 2160 34817 2160 4202560 1 0 0 0 0 0 0 0 25 0 11 0 57584628 904798208 87120 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14819] ppid=14798 vsize=883592 CPUtime=0
/proc/14810/task/14819/stat : 14819 (java) S 14798 14796 2160 34817 2160 4202560 2 0 0 0 0 0 0 0 15 0 11 0 57584628 904798208 87120 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14821] ppid=14798 vsize=883592 CPUtime=0
/proc/14810/task/14821/stat : 14821 (java) S 14798 14796 2160 34817 2160 4202560 4 0 0 0 0 0 0 0 25 0 11 0 57585030 904798208 87120 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
Current children cumulated CPU time (s) 161.38
Current children cumulated vsize (KiB) 888728

[startup+222.309 s]
/proc/loadavg: 1.00 1.00 1.00 2/46 14824
/proc/meminfo: memFree=585816/1048576 swapFree=0/0
[pid=14796] ppid=14795 vsize=2568 CPUtime=0
/proc/14796/stat : 14796 (p2cudf-user-1.1) S 14795 14796 2160 34817 2160 4202496 374 0 0 0 0 0 0 0 25 0 1 0 57584576 2629632 270 1283457024 134512640 135304128 4289633472 18446744073709551615 4294960130 0 65536 4 65538 18446744071564329979 0 0 17 0 0 0 0
/proc/14796/statm: 642 270 230 194 0 29 0
[pid=14798] ppid=14796 vsize=2568 CPUtime=0.02
/proc/14798/stat : 14798 (p2cudf) S 14796 14796 2160 34817 2160 4202496 387 3014 0 1 0 0 2 0 25 0 1 0 57584577 2629632 279 1283457024 134512640 135304128 4290547136 18446744073709551615 4294960130 0 65536 4 65538 18446744071564329979 0 0 17 0 0 0 0
/proc/14798/statm: 642 279 239 194 0 29 0
[pid=14810] ppid=14798 vsize=883592 CPUtime=221.32
/proc/14810/stat : 14810 (java) S 14798 14796 2160 34817 2160 4202496 91828 0 105 0 22099 33 0 0 23 0 11 0 57584580 904798208 87120 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 0 0 16800975 18446744073709551615 0 0 17 0 0 0 0
/proc/14810/statm: 220898 87120 1783 10 0 217989 0
[pid=14810/tid=14811] ppid=14798 vsize=883592 CPUtime=209.52
/proc/14810/task/14811/stat : 14811 (java) R 14798 14796 2160 34817 2160 4202560 50274 0 15 0 20930 22 0 0 25 0 11 0 57584607 904798208 87120 1283457024 134512640 134550932 4290911424 18446744073709551615 4095514806 0 4 0 16800975 0 0 0 -1 0 0 0 0
[pid=14810/tid=14812] ppid=14798 vsize=883592 CPUtime=9.36
/proc/14810/task/14812/stat : 14812 (java) S 14798 14796 2160 34817 2160 4202560 28492 0 0 0 928 8 0 0 15 0 11 0 57584617 904798208 87120 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 0 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14813] ppid=14798 vsize=883592 CPUtime=0
/proc/14810/task/14813/stat : 14813 (java) S 14798 14796 2160 34817 2160 4202560 8 0 1 0 0 0 0 0 18 0 11 0 57584617 904798208 87120 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14814] ppid=14798 vsize=883592 CPUtime=0
/proc/14810/task/14814/stat : 14814 (java) S 14798 14796 2160 34817 2160 4202560 6 0 0 0 0 0 0 0 18 0 11 0 57584618 904798208 87120 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14815] ppid=14798 vsize=883592 CPUtime=0
/proc/14810/task/14815/stat : 14815 (java) S 14798 14796 2160 34817 2160 4202560 1 0 0 0 0 0 0 0 25 0 11 0 57584628 904798208 87120 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14816] ppid=14798 vsize=883592 CPUtime=2.27
/proc/14810/task/14816/stat : 14816 (java) S 14798 14796 2160 34817 2160 4202560 10003 0 1 0 225 2 0 0 15 0 11 0 57584628 904798208 87120 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14817] ppid=14798 vsize=883592 CPUtime=0.15
/proc/14810/task/14817/stat : 14817 (java) S 14798 14796 2160 34817 2160 4202560 2061 0 7 0 15 0 0 0 15 0 11 0 57584628 904798208 87120 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14818] ppid=14798 vsize=883592 CPUtime=0
/proc/14810/task/14818/stat : 14818 (java) S 14798 14796 2160 34817 2160 4202560 1 0 0 0 0 0 0 0 25 0 11 0 57584628 904798208 87120 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14819] ppid=14798 vsize=883592 CPUtime=0
/proc/14810/task/14819/stat : 14819 (java) S 14798 14796 2160 34817 2160 4202560 2 0 0 0 0 0 0 0 15 0 11 0 57584628 904798208 87120 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14821] ppid=14798 vsize=883592 CPUtime=0
/proc/14810/task/14821/stat : 14821 (java) S 14798 14796 2160 34817 2160 4202560 4 0 0 0 0 0 0 0 25 0 11 0 57585030 904798208 87120 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
Current children cumulated CPU time (s) 221.34
Current children cumulated vsize (KiB) 888728

[startup+282.323 s]
/proc/loadavg: 1.07 1.02 1.00 2/46 14824
/proc/meminfo: memFree=585816/1048576 swapFree=0/0
[pid=14796] ppid=14795 vsize=2568 CPUtime=0
/proc/14796/stat : 14796 (p2cudf-user-1.1) S 14795 14796 2160 34817 2160 4202496 374 0 0 0 0 0 0 0 25 0 1 0 57584576 2629632 270 1283457024 134512640 135304128 4289633472 18446744073709551615 4294960130 0 65536 4 65538 18446744071564329979 0 0 17 0 0 0 0
/proc/14796/statm: 642 270 230 194 0 29 0
[pid=14798] ppid=14796 vsize=2568 CPUtime=0.02
/proc/14798/stat : 14798 (p2cudf) S 14796 14796 2160 34817 2160 4202496 387 3014 0 1 0 0 2 0 25 0 1 0 57584577 2629632 279 1283457024 134512640 135304128 4290547136 18446744073709551615 4294960130 0 65536 4 65538 18446744071564329979 0 0 17 0 0 0 0
/proc/14798/statm: 642 279 239 194 0 29 0
[pid=14810] ppid=14798 vsize=883592 CPUtime=281.32
/proc/14810/stat : 14810 (java) S 14798 14796 2160 34817 2160 4202496 91852 0 105 0 28099 33 0 0 23 0 11 0 57584580 904798208 87144 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 0 0 16800975 18446744073709551615 0 0 17 0 0 0 0
/proc/14810/statm: 220898 87144 1783 10 0 217989 0
[pid=14810/tid=14811] ppid=14798 vsize=883592 CPUtime=267.16
/proc/14810/task/14811/stat : 14811 (java) R 14798 14796 2160 34817 2160 4202560 50274 0 15 0 26694 22 0 0 25 0 11 0 57584607 904798208 87144 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 0 0 0 -1 0 0 0 0
[pid=14810/tid=14812] ppid=14798 vsize=883592 CPUtime=11.72
/proc/14810/task/14812/stat : 14812 (java) R 14798 14796 2160 34817 2160 4202560 28516 0 0 0 1164 8 0 0 15 0 11 0 57584617 904798208 87144 1283457024 134512640 134550932 4290911424 18446744073709551615 4152521184 0 0 0 16800975 0 0 0 -1 0 0 0 0
[pid=14810/tid=14813] ppid=14798 vsize=883592 CPUtime=0
/proc/14810/task/14813/stat : 14813 (java) S 14798 14796 2160 34817 2160 4202560 8 0 1 0 0 0 0 0 18 0 11 0 57584617 904798208 87144 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14814] ppid=14798 vsize=883592 CPUtime=0
/proc/14810/task/14814/stat : 14814 (java) S 14798 14796 2160 34817 2160 4202560 6 0 0 0 0 0 0 0 18 0 11 0 57584618 904798208 87144 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14815] ppid=14798 vsize=883592 CPUtime=0
/proc/14810/task/14815/stat : 14815 (java) S 14798 14796 2160 34817 2160 4202560 1 0 0 0 0 0 0 0 25 0 11 0 57584628 904798208 87144 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14816] ppid=14798 vsize=883592 CPUtime=2.27
/proc/14810/task/14816/stat : 14816 (java) S 14798 14796 2160 34817 2160 4202560 10003 0 1 0 225 2 0 0 15 0 11 0 57584628 904798208 87144 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14817] ppid=14798 vsize=883592 CPUtime=0.15
/proc/14810/task/14817/stat : 14817 (java) S 14798 14796 2160 34817 2160 4202560 2061 0 7 0 15 0 0 0 15 0 11 0 57584628 904798208 87144 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14818] ppid=14798 vsize=883592 CPUtime=0
/proc/14810/task/14818/stat : 14818 (java) S 14798 14796 2160 34817 2160 4202560 1 0 0 0 0 0 0 0 25 0 11 0 57584628 904798208 87144 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14819] ppid=14798 vsize=883592 CPUtime=0
/proc/14810/task/14819/stat : 14819 (java) S 14798 14796 2160 34817 2160 4202560 2 0 0 0 0 0 0 0 15 0 11 0 57584628 904798208 87144 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14821] ppid=14798 vsize=883592 CPUtime=0
/proc/14810/task/14821/stat : 14821 (java) S 14798 14796 2160 34817 2160 4202560 4 0 0 0 0 0 0 0 25 0 11 0 57585030 904798208 87144 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
Current children cumulated CPU time (s) 281.34
Current children cumulated vsize (KiB) 888728

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

[startup+283.213 s]
/proc/loadavg: 1.07 1.02 1.00 2/46 14824
/proc/meminfo: memFree=585816/1048576 swapFree=0/0
[pid=14796] ppid=14795 vsize=2568 CPUtime=0
/proc/14796/stat : 14796 (p2cudf-user-1.1) S 14795 14796 2160 34817 2160 4202496 374 0 0 0 0 0 0 0 25 0 1 0 57584576 2629632 270 1283457024 134512640 135304128 4289633472 18446744073709551615 4294960130 0 65536 4 65538 18446744071564329979 0 0 17 0 0 0 0
/proc/14796/statm: 642 270 230 194 0 29 0
[pid=14798] ppid=14796 vsize=2568 CPUtime=0.02
/proc/14798/stat : 14798 (p2cudf) S 14796 14796 2160 34817 2160 4202496 387 3014 0 1 0 0 2 0 25 0 1 0 57584577 2629632 279 1283457024 134512640 135304128 4290547136 18446744073709551615 4294960130 0 65536 4 65538 18446744071564329979 0 0 17 0 0 0 0
/proc/14798/statm: 642 279 239 194 0 29 0
[pid=14810] ppid=14798 vsize=883592 CPUtime=282.21
/proc/14810/stat : 14810 (java) S 14798 14796 2160 34817 2160 4202496 91852 0 105 0 28188 33 0 0 23 0 11 0 57584580 904798208 87144 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 0 0 16800975 18446744073709551615 0 0 17 0 0 0 0
/proc/14810/statm: 220898 87144 1783 10 0 217989 0
[pid=14810/tid=14811] ppid=14798 vsize=883592 CPUtime=267.98
/proc/14810/task/14811/stat : 14811 (java) R 14798 14796 2160 34817 2160 4202560 50274 0 15 0 26776 22 0 0 25 0 11 0 57584607 904798208 87144 1283457024 134512640 134550932 4290911424 18446744073709551615 4095157424 0 4 0 16800975 0 0 0 -1 0 0 0 0
[pid=14810/tid=14812] ppid=14798 vsize=883592 CPUtime=11.79
/proc/14810/task/14812/stat : 14812 (java) S 14798 14796 2160 34817 2160 4202560 28516 0 0 0 1171 8 0 0 16 0 11 0 57584617 904798208 87144 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 0 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14813] ppid=14798 vsize=883592 CPUtime=0
/proc/14810/task/14813/stat : 14813 (java) S 14798 14796 2160 34817 2160 4202560 8 0 1 0 0 0 0 0 18 0 11 0 57584617 904798208 87144 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14814] ppid=14798 vsize=883592 CPUtime=0
/proc/14810/task/14814/stat : 14814 (java) S 14798 14796 2160 34817 2160 4202560 6 0 0 0 0 0 0 0 18 0 11 0 57584618 904798208 87144 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14815] ppid=14798 vsize=883592 CPUtime=0
/proc/14810/task/14815/stat : 14815 (java) S 14798 14796 2160 34817 2160 4202560 1 0 0 0 0 0 0 0 25 0 11 0 57584628 904798208 87144 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14816] ppid=14798 vsize=883592 CPUtime=2.27
/proc/14810/task/14816/stat : 14816 (java) S 14798 14796 2160 34817 2160 4202560 10003 0 1 0 225 2 0 0 15 0 11 0 57584628 904798208 87144 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14817] ppid=14798 vsize=883592 CPUtime=0.15
/proc/14810/task/14817/stat : 14817 (java) S 14798 14796 2160 34817 2160 4202560 2061 0 7 0 15 0 0 0 15 0 11 0 57584628 904798208 87144 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14818] ppid=14798 vsize=883592 CPUtime=0
/proc/14810/task/14818/stat : 14818 (java) S 14798 14796 2160 34817 2160 4202560 1 0 0 0 0 0 0 0 25 0 11 0 57584628 904798208 87144 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14819] ppid=14798 vsize=883592 CPUtime=0
/proc/14810/task/14819/stat : 14819 (java) R 14798 14796 2160 34817 2160 4202560 2 0 0 0 0 0 0 0 15 0 11 0 57584628 904798208 87144 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 0 0 0 -1 0 0 0 0
[pid=14810/tid=14821] ppid=14798 vsize=883592 CPUtime=0
/proc/14810/task/14821/stat : 14821 (java) S 14798 14796 2160 34817 2160 4202560 4 0 0 0 0 0 0 0 25 0 11 0 57585030 904798208 87144 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
Current children cumulated CPU time (s) 282.23
Current children cumulated vsize (KiB) 888728

[startup+284.013 s]
/proc/loadavg: 1.07 1.02 1.00 3/46 14824
/proc/meminfo: memFree=585816/1048576 swapFree=0/0
[pid=14796] ppid=14795 vsize=2568 CPUtime=0
/proc/14796/stat : 14796 (p2cudf-user-1.1) S 14795 14796 2160 34817 2160 4202496 374 0 0 0 0 0 0 0 25 0 1 0 57584576 2629632 270 1283457024 134512640 135304128 4289633472 18446744073709551615 4294960130 0 65536 4 65538 18446744071564329979 0 0 17 0 0 0 0
/proc/14796/statm: 642 270 230 194 0 29 0
[pid=14798] ppid=14796 vsize=2568 CPUtime=0.02
/proc/14798/stat : 14798 (p2cudf) S 14796 14796 2160 34817 2160 4202496 387 3014 0 1 0 0 2 0 25 0 1 0 57584577 2629632 279 1283457024 134512640 135304128 4290547136 18446744073709551615 4294960130 0 65536 4 65538 18446744071564329979 0 0 17 0 0 0 0
/proc/14798/statm: 642 279 239 194 0 29 0
[pid=14810] ppid=14798 vsize=883592 CPUtime=283.01
/proc/14810/stat : 14810 (java) S 14798 14796 2160 34817 2160 4202496 91852 0 105 0 28268 33 0 0 23 0 11 0 57584580 904798208 87144 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 0 0 16800975 18446744073709551615 0 0 17 0 0 0 0
/proc/14810/statm: 220898 87144 1783 10 0 217989 0
[pid=14810/tid=14811] ppid=14798 vsize=883592 CPUtime=268.78
/proc/14810/task/14811/stat : 14811 (java) R 14798 14796 2160 34817 2160 4202560 50274 0 15 0 26856 22 0 0 25 0 11 0 57584607 904798208 87144 1283457024 134512640 134550932 4290911424 18446744073709551615 4095700884 0 4 0 16800975 0 0 0 -1 0 0 0 0
[pid=14810/tid=14812] ppid=14798 vsize=883592 CPUtime=11.79
/proc/14810/task/14812/stat : 14812 (java) S 14798 14796 2160 34817 2160 4202560 28516 0 0 0 1171 8 0 0 15 0 11 0 57584617 904798208 87144 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 0 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14813] ppid=14798 vsize=883592 CPUtime=0
/proc/14810/task/14813/stat : 14813 (java) S 14798 14796 2160 34817 2160 4202560 8 0 1 0 0 0 0 0 18 0 11 0 57584617 904798208 87144 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14814] ppid=14798 vsize=883592 CPUtime=0
/proc/14810/task/14814/stat : 14814 (java) S 14798 14796 2160 34817 2160 4202560 6 0 0 0 0 0 0 0 18 0 11 0 57584618 904798208 87144 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14815] ppid=14798 vsize=883592 CPUtime=0
/proc/14810/task/14815/stat : 14815 (java) S 14798 14796 2160 34817 2160 4202560 1 0 0 0 0 0 0 0 25 0 11 0 57584628 904798208 87144 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14816] ppid=14798 vsize=883592 CPUtime=2.27
/proc/14810/task/14816/stat : 14816 (java) S 14798 14796 2160 34817 2160 4202560 10003 0 1 0 225 2 0 0 15 0 11 0 57584628 904798208 87144 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14817] ppid=14798 vsize=883592 CPUtime=0.15
/proc/14810/task/14817/stat : 14817 (java) S 14798 14796 2160 34817 2160 4202560 2061 0 7 0 15 0 0 0 15 0 11 0 57584628 904798208 87144 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14818] ppid=14798 vsize=883592 CPUtime=0
/proc/14810/task/14818/stat : 14818 (java) S 14798 14796 2160 34817 2160 4202560 1 0 0 0 0 0 0 0 25 0 11 0 57584628 904798208 87144 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14819] ppid=14798 vsize=883592 CPUtime=0
/proc/14810/task/14819/stat : 14819 (java) S 14798 14796 2160 34817 2160 4202560 2 0 0 0 0 0 0 0 15 0 11 0 57584628 904798208 87144 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14821] ppid=14798 vsize=883592 CPUtime=0
/proc/14810/task/14821/stat : 14821 (java) S 14798 14796 2160 34817 2160 4202560 4 0 0 0 0 0 0 0 25 0 11 0 57585030 904798208 87144 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
Current children cumulated CPU time (s) 283.03
Current children cumulated vsize (KiB) 888728

[startup+284.808 s]
/proc/loadavg: 1.07 1.02 1.00 3/46 14824
/proc/meminfo: memFree=585816/1048576 swapFree=0/0
[pid=14796] ppid=14795 vsize=2568 CPUtime=0
/proc/14796/stat : 14796 (p2cudf-user-1.1) S 14795 14796 2160 34817 2160 4202496 374 0 0 0 0 0 0 0 25 0 1 0 57584576 2629632 270 1283457024 134512640 135304128 4289633472 18446744073709551615 4294960130 0 65536 4 65538 18446744071564329979 0 0 17 0 0 0 0
/proc/14796/statm: 642 270 230 194 0 29 0
[pid=14798] ppid=14796 vsize=2568 CPUtime=0.02
/proc/14798/stat : 14798 (p2cudf) S 14796 14796 2160 34817 2160 4202496 387 3014 0 1 0 0 2 0 25 0 1 0 57584577 2629632 279 1283457024 134512640 135304128 4290547136 18446744073709551615 4294960130 0 65536 4 65538 18446744071564329979 0 0 17 0 0 0 0
/proc/14798/statm: 642 279 239 194 0 29 0
[pid=14810] ppid=14798 vsize=883916 CPUtime=283.57
/proc/14810/stat : 14810 (java) S 14798 14796 2160 34817 2160 4202496 91866 0 105 0 28324 33 0 0 23 0 11 0 57584580 905129984 87158 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 0 0 16800975 18446744073709551615 0 0 17 0 0 0 0
/proc/14810/statm: 220979 87158 1784 10 0 218070 0
[pid=14810/tid=14811] ppid=14798 vsize=883916 CPUtime=269.32
/proc/14810/task/14811/stat : 14811 (java) S 14798 14796 2160 34817 2160 4202560 50282 0 15 0 26910 22 0 0 25 0 11 0 57584607 905129984 87158 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14812] ppid=14798 vsize=883916 CPUtime=11.79
/proc/14810/task/14812/stat : 14812 (java) S 14798 14796 2160 34817 2160 4202560 28516 0 0 0 1171 8 0 0 16 0 11 0 57584617 905129984 87158 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 0 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14813] ppid=14798 vsize=883916 CPUtime=0
/proc/14810/task/14813/stat : 14813 (java) S 14798 14796 2160 34817 2160 4202560 8 0 1 0 0 0 0 0 18 0 11 0 57584617 905129984 87158 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14814] ppid=14798 vsize=883916 CPUtime=0
/proc/14810/task/14814/stat : 14814 (java) S 14798 14796 2160 34817 2160 4202560 6 0 0 0 0 0 0 0 18 0 11 0 57584618 905129984 87158 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14815] ppid=14798 vsize=883916 CPUtime=0
/proc/14810/task/14815/stat : 14815 (java) S 14798 14796 2160 34817 2160 4202560 1 0 0 0 0 0 0 0 25 0 11 0 57584628 905129984 87158 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14816] ppid=14798 vsize=883916 CPUtime=2.29
/proc/14810/task/14816/stat : 14816 (java) S 14798 14796 2160 34817 2160 4202560 10003 0 1 0 227 2 0 0 15 0 11 0 57584628 905129984 87158 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14817] ppid=14798 vsize=883916 CPUtime=0.15
/proc/14810/task/14817/stat : 14817 (java) S 14798 14796 2160 34817 2160 4202560 2061 0 7 0 15 0 0 0 15 0 11 0 57584628 905129984 87158 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14818] ppid=14798 vsize=883916 CPUtime=0
/proc/14810/task/14818/stat : 14818 (java) S 14798 14796 2160 34817 2160 4202560 1 0 0 0 0 0 0 0 25 0 11 0 57584628 905129984 87158 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14819] ppid=14798 vsize=883916 CPUtime=0
/proc/14810/task/14819/stat : 14819 (java) S 14798 14796 2160 34817 2160 4202560 2 0 0 0 0 0 0 0 15 0 11 0 57584628 905129984 87158 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
Current children cumulated CPU time (s) 283.59
Current children cumulated vsize (KiB) 889052

[startup+285.202 s]
/proc/loadavg: 1.07 1.02 1.00 1/46 14825
/proc/meminfo: memFree=585692/1048576 swapFree=0/0
[pid=14796] ppid=14795 vsize=2568 CPUtime=0
/proc/14796/stat : 14796 (p2cudf-user-1.1) S 14795 14796 2160 34817 2160 4202496 374 0 0 0 0 0 0 0 25 0 1 0 57584576 2629632 270 1283457024 134512640 135304128 4289633472 18446744073709551615 4294960130 0 65536 4 65538 18446744071564329979 0 0 17 0 0 0 0
/proc/14796/statm: 642 270 230 194 0 29 0
[pid=14798] ppid=14796 vsize=2568 CPUtime=0.02
/proc/14798/stat : 14798 (p2cudf) S 14796 14796 2160 34817 2160 4202496 387 3014 0 1 0 0 2 0 25 0 1 0 57584577 2629632 279 1283457024 134512640 135304128 4290547136 18446744073709551615 4294960130 0 65536 4 65538 18446744071564329979 0 0 17 0 0 0 0
/proc/14798/statm: 642 279 239 194 0 29 0
[pid=14810] ppid=14798 vsize=883916 CPUtime=283.67
/proc/14810/stat : 14810 (java) S 14798 14796 2160 34817 2160 4202496 91867 0 105 0 28331 36 0 0 23 0 11 0 57584580 905129984 87159 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 0 0 16800975 18446744073709551615 0 0 17 0 0 0 0
/proc/14810/statm: 220979 87159 1784 10 0 218070 0
[pid=14810/tid=14811] ppid=14798 vsize=883916 CPUtime=269.32
/proc/14810/task/14811/stat : 14811 (java) S 14798 14796 2160 34817 2160 4202560 50282 0 15 0 26910 22 0 0 25 0 11 0 57584607 905129984 87159 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14812] ppid=14798 vsize=883916 CPUtime=11.79
/proc/14810/task/14812/stat : 14812 (java) S 14798 14796 2160 34817 2160 4202560 28516 0 0 0 1171 8 0 0 16 0 11 0 57584617 905129984 87159 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 0 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14813] ppid=14798 vsize=883916 CPUtime=0
/proc/14810/task/14813/stat : 14813 (java) S 14798 14796 2160 34817 2160 4202560 8 0 1 0 0 0 0 0 18 0 11 0 57584617 905129984 87159 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14814] ppid=14798 vsize=883916 CPUtime=0
/proc/14810/task/14814/stat : 14814 (java) S 14798 14796 2160 34817 2160 4202560 6 0 0 0 0 0 0 0 18 0 11 0 57584618 905129984 87159 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14815] ppid=14798 vsize=883916 CPUtime=0
/proc/14810/task/14815/stat : 14815 (java) S 14798 14796 2160 34817 2160 4202560 1 0 0 0 0 0 0 0 25 0 11 0 57584628 905129984 87159 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14816] ppid=14798 vsize=883916 CPUtime=2.32
/proc/14810/task/14816/stat : 14816 (java) S 14798 14796 2160 34817 2160 4202560 10003 0 1 0 230 2 0 0 15 0 11 0 57584628 905129984 87159 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14817] ppid=14798 vsize=883916 CPUtime=0.15
/proc/14810/task/14817/stat : 14817 (java) S 14798 14796 2160 34817 2160 4202560 2061 0 7 0 15 0 0 0 15 0 11 0 57584628 905129984 87159 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14818] ppid=14798 vsize=883916 CPUtime=0
/proc/14810/task/14818/stat : 14818 (java) S 14798 14796 2160 34817 2160 4202560 1 0 0 0 0 0 0 0 25 0 11 0 57584628 905129984 87159 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14819] ppid=14798 vsize=883916 CPUtime=0
/proc/14810/task/14819/stat : 14819 (java) S 14798 14796 2160 34817 2160 4202560 2 0 0 0 0 0 0 0 15 0 11 0 57584628 905129984 87159 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14825] ppid=14798 vsize=883916 CPUtime=0.06
/proc/14810/task/14825/stat : 14825 (java) R 14798 14796 2160 34817 2160 4202560 6 0 0 0 4 2 0 0 20 0 11 0 57613039 905129984 87159 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 0 0 0 -1 0 0 0 0
Current children cumulated CPU time (s) 283.69
Current children cumulated vsize (KiB) 889052

[startup+285.304 s]
/proc/loadavg: 1.07 1.02 1.00 1/46 14825
/proc/meminfo: memFree=585692/1048576 swapFree=0/0
[pid=14796] ppid=14795 vsize=2568 CPUtime=0
/proc/14796/stat : 14796 (p2cudf-user-1.1) S 14795 14796 2160 34817 2160 4202496 374 0 0 0 0 0 0 0 25 0 1 0 57584576 2629632 270 1283457024 134512640 135304128 4289633472 18446744073709551615 4294960130 0 65536 4 65538 18446744071564329979 0 0 17 0 0 0 0
/proc/14796/statm: 642 270 230 194 0 29 0
[pid=14798] ppid=14796 vsize=2568 CPUtime=0.02
/proc/14798/stat : 14798 (p2cudf) S 14796 14796 2160 34817 2160 4202496 387 3014 0 1 0 0 2 0 25 0 1 0 57584577 2629632 279 1283457024 134512640 135304128 4290547136 18446744073709551615 4294960130 0 65536 4 65538 18446744071564329979 0 0 17 0 0 0 0
/proc/14798/statm: 642 279 239 194 0 29 0
[pid=14810] ppid=14798 vsize=883916 CPUtime=283.74
/proc/14810/stat : 14810 (java) S 14798 14796 2160 34817 2160 4202496 91868 0 105 0 28338 36 0 0 23 0 10 0 57584580 905129984 87160 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 0 0 16800975 18446744073709551615 0 0 17 0 0 0 0
/proc/14810/statm: 220979 87160 1785 10 0 218070 0
[pid=14810/tid=14811] ppid=14798 vsize=883916 CPUtime=269.32
/proc/14810/task/14811/stat : 14811 (java) S 14798 14796 2160 34817 2160 4202560 50282 0 15 0 26910 22 0 0 19 0 10 0 57584607 905129984 87160 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14812] ppid=14798 vsize=883916 CPUtime=11.79
/proc/14810/task/14812/stat : 14812 (java) S 14798 14796 2160 34817 2160 4202560 28516 0 0 0 1171 8 0 0 16 0 10 0 57584617 905129984 87160 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 0 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14813] ppid=14798 vsize=883916 CPUtime=0
/proc/14810/task/14813/stat : 14813 (java) S 14798 14796 2160 34817 2160 4202560 8 0 1 0 0 0 0 0 18 0 10 0 57584617 905129984 87160 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14814] ppid=14798 vsize=883916 CPUtime=0
/proc/14810/task/14814/stat : 14814 (java) S 14798 14796 2160 34817 2160 4202560 6 0 0 0 0 0 0 0 18 0 10 0 57584618 905129984 87160 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14815] ppid=14798 vsize=883916 CPUtime=0
/proc/14810/task/14815/stat : 14815 (java) S 14798 14796 2160 34817 2160 4202560 1 0 0 0 0 0 0 0 25 0 10 0 57584628 905129984 87160 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14816] ppid=14798 vsize=883916 CPUtime=2.39
/proc/14810/task/14816/stat : 14816 (java) S 14798 14796 2160 34817 2160 4202560 10004 0 1 0 237 2 0 0 16 0 10 0 57584628 905129984 87160 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14817] ppid=14798 vsize=883916 CPUtime=0.15
/proc/14810/task/14817/stat : 14817 (java) S 14798 14796 2160 34817 2160 4202560 2061 0 7 0 15 0 0 0 15 0 10 0 57584628 905129984 87160 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14818] ppid=14798 vsize=883916 CPUtime=0
/proc/14810/task/14818/stat : 14818 (java) S 14798 14796 2160 34817 2160 4202560 1 0 0 0 0 0 0 0 25 0 10 0 57584628 905129984 87160 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
[pid=14810/tid=14819] ppid=14798 vsize=883916 CPUtime=0
/proc/14810/task/14819/stat : 14819 (java) S 14798 14796 2160 34817 2160 4202560 2 0 0 0 0 0 0 0 15 0 10 0 57584628 905129984 87160 1283457024 134512640 134550932 4290911424 18446744073709551615 4294960130 0 4 0 16800975 18446612133395904512 0 0 -1 0 0 0 0
Current children cumulated CPU time (s) 283.76
Current children cumulated vsize (KiB) 889052

Child status: 0
Real time (s): 285.349
CPU time (s): 283.81
CPU user time (s): 283.41
CPU system time (s): 0.400025
CPU usage (%): 99.4607
Max. virtual memory (cumulated for all children) (KiB): 891300

getrusage(RUSAGE_CHILDREN,...) data:
user time used= 283.41
system time used= 0.400025
maximum resident set size= 0
integral shared memory size= 0
integral unshared data size= 0
integral unshared stack size= 0
page reclaims= 95666
page faults= 106
swaps= 0
block input operations= 0
block output operations= 0
messages sent= 0
messages received= 0
signals received= 0
voluntary context switches= 6519
involuntary context switches= 8846

runsolver used 0.004 second user time and 0 second system time

The end