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/201012070034/p2cudf-trendy-1.9/rand0aa5c1.cudf.difficult.log.runsolver ./p2cudf-trendy-1.9 /home/misc2010/data/2010/difficult//rand0aa5c1.cudf /home/misc2010/tmp/201012070034/p2cudf-trendy-1.9/rand0aa5c1.cudf.difficult.result 

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: 1.00 1.02 1.00 1/43 7355
/proc/meminfo: memFree=887188/1048576 swapFree=2077664/2097144
[pid=7355] ppid=7354 vsize=3024 CPUtime=0
/proc/7355/stat : 7355 (runsolver) D 7354 7355 4159 34819 4229 4202560 72 0 0 0 0 0 0 0 23 0 1 0 878244928 3096576 94 1283457024 134512640 134586868 4294936912 18446744073709551615 4294960130 0 0 0 24578 18446744071564332000 0 0 17 0 0 0 0
/proc/7355/statm: 756 94 62 19 0 54 0

[startup+0.152555 s]
/proc/loadavg: 1.00 1.02 1.00 1/43 7355
/proc/meminfo: memFree=887188/1048576 swapFree=2077664/2097144
[pid=7355] ppid=7354 vsize=2572 CPUtime=0
/proc/7355/stat : 7355 (p2cudf-trendy-1) S 7354 7355 4159 34819 4229 4202496 375 0 0 0 0 0 0 0 24 0 1 0 878244928 2633728 272 1283457024 134512640 135304128 4290883136 18446744073709551615 4294960130 0 65536 4 65538 18446744071564329979 0 0 17 0 0 0 0
/proc/7355/statm: 643 272 233 194 0 29 0
Current children cumulated CPU time (s) 0
Current children cumulated vsize (KiB) 2572

[startup+0.204587 s]
/proc/loadavg: 1.00 1.02 1.00 1/43 7355
/proc/meminfo: memFree=887188/1048576 swapFree=2077664/2097144
[pid=7355] ppid=7354 vsize=2572 CPUtime=0
/proc/7355/stat : 7355 (p2cudf-trendy-1) S 7354 7355 4159 34819 4229 4202496 375 0 0 0 0 0 0 0 24 0 1 0 878244928 2633728 272 1283457024 134512640 135304128 4290883136 18446744073709551615 4294960130 0 65536 4 65538 18446744071564329979 0 0 17 0 0 0 0
/proc/7355/statm: 643 272 233 194 0 29 0
Current children cumulated CPU time (s) 0
Current children cumulated vsize (KiB) 2572

[startup+0.304577 s]
/proc/loadavg: 1.00 1.02 1.00 1/43 7355
/proc/meminfo: memFree=887188/1048576 swapFree=2077664/2097144
[pid=7355] ppid=7354 vsize=2572 CPUtime=0
/proc/7355/stat : 7355 (p2cudf-trendy-1) S 7354 7355 4159 34819 4229 4202496 375 0 0 0 0 0 0 0 24 0 1 0 878244928 2633728 272 1283457024 134512640 135304128 4290883136 18446744073709551615 4294960130 0 65536 4 65538 18446744071564329979 0 0 17 0 0 0 0
/proc/7355/statm: 643 272 233 194 0 29 0
Current children cumulated CPU time (s) 0
Current children cumulated vsize (KiB) 2572

[startup+0.704593 s]
/proc/loadavg: 1.00 1.02 1.00 1/43 7355
/proc/meminfo: memFree=887188/1048576 swapFree=2077664/2097144
[pid=7355] ppid=7354 vsize=2572 CPUtime=0
/proc/7355/stat : 7355 (p2cudf-trendy-1) S 7354 7355 4159 34819 4229 4202496 375 0 0 0 0 0 0 0 24 0 1 0 878244928 2633728 272 1283457024 134512640 135304128 4290883136 18446744073709551615 4294960130 0 65536 4 65538 18446744071564329979 0 0 17 0 0 0 0
/proc/7355/statm: 643 272 233 194 0 29 0
Current children cumulated CPU time (s) 0
Current children cumulated vsize (KiB) 2572

[startup+1.50465 s]
/proc/loadavg: 1.00 1.02 1.00 1/46 7369
/proc/meminfo: memFree=868548/1048576 swapFree=2077664/2097144
[pid=7355] ppid=7354 vsize=2572 CPUtime=0
/proc/7355/stat : 7355 (p2cudf-trendy-1) S 7354 7355 4159 34819 4229 4202496 375 0 0 0 0 0 0 0 24 0 1 0 878244928 2633728 272 1283457024 134512640 135304128 4290883136 18446744073709551615 4294960130 0 65536 4 65538 18446744071564329979 0 0 17 0 0 0 0
/proc/7355/statm: 643 272 233 194 0 29 0
[pid=7357] ppid=7355 vsize=2576 CPUtime=0
/proc/7357/stat : 7357 (p2cudf) S 7355 7355 4159 34819 4229 4202496 395 2855 0 132 0 0 0 0 18 0 1 0 878244928 2637824 283 1283457024 134512640 135304128 4288324544 18446744073709551615 4294960130 0 65536 4 65538 18446744071564329979 0 0 17 0 0 0 0
/proc/7357/statm: 644 283 241 194 0 30 0
[pid=7369] ppid=7357 vsize=855384 CPUtime=0.06
/proc/7369/stat : 7369 (java) S 7357 7355 4159 34819 4229 4202496 3270 0 146 0 6 0 0 0 18 0 10 0 878245002 875913216 3116 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 0 0 16800975 18446744073709551615 0 0 17 0 0 0 0
/proc/7369/statm: 213846 3116 1406 10 0 210964 0
Current children cumulated CPU time (s) 0.06
Current children cumulated vsize (KiB) 860532

[startup+3.10093 s]
/proc/loadavg: 1.00 1.02 1.00 3/55 7378
/proc/meminfo: memFree=839852/1048576 swapFree=2077664/2097144
[pid=7355] ppid=7354 vsize=2572 CPUtime=0
/proc/7355/stat : 7355 (p2cudf-trendy-1) S 7354 7355 4159 34819 4229 4202496 375 0 0 0 0 0 0 0 24 0 1 0 878244928 2633728 272 1283457024 134512640 135304128 4290883136 18446744073709551615 4294960130 0 65536 4 65538 18446744071564329979 0 0 17 0 0 0 0
/proc/7355/statm: 643 272 233 194 0 29 0
[pid=7357] ppid=7355 vsize=2576 CPUtime=0
/proc/7357/stat : 7357 (p2cudf) S 7355 7355 4159 34819 4229 4202496 395 2855 0 132 0 0 0 0 18 0 1 0 878244928 2637824 283 1283457024 134512640 135304128 4288324544 18446744073709551615 4294960130 0 65536 4 65538 18446744071564329979 0 0 17 0 0 0 0
/proc/7357/statm: 644 283 241 194 0 30 0
[pid=7369] ppid=7357 vsize=871476 CPUtime=1.34
/proc/7369/stat : 7369 (java) S 7357 7355 4159 34819 4229 4202496 20701 0 153 0 124 10 0 0 18 0 10 0 878245002 892391424 16906 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 0 0 16800975 18446744073709551615 0 0 17 0 0 0 0
/proc/7369/statm: 217869 16906 1742 10 0 214959 0
[pid=7369/tid=7370] ppid=7357 vsize=871476 CPUtime=0.39
/proc/7369/task/7370/stat : 7370 (java) R 7357 7355 4159 34819 4229 4202560 11566 0 58 0 31 8 0 0 19 0 10 0 878245041 892391424 16906 1283457024 134512640 134550932 4294764672 18446744073709551615 4095487843 0 4 0 16800975 0 0 0 -1 0 0 0 0
[pid=7369/tid=7371] ppid=7357 vsize=871476 CPUtime=0
/proc/7369/task/7371/stat : 7371 (java) S 7357 7355 4159 34819 4229 4202560 5 0 0 0 0 0 0 0 15 0 10 0 878245053 892391424 16906 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 0 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
[pid=7369/tid=7372] ppid=7357 vsize=871476 CPUtime=0
/proc/7369/task/7372/stat : 7372 (java) S 7357 7355 4159 34819 4229 4202560 8 0 1 0 0 0 0 0 19 0 10 0 878245054 892391424 16906 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
[pid=7369/tid=7373] ppid=7357 vsize=871476 CPUtime=0
/proc/7369/task/7373/stat : 7373 (java) S 7357 7355 4159 34819 4229 4202560 4 0 0 0 0 0 0 0 20 0 10 0 878245054 892391424 16906 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
[pid=7369/tid=7374] ppid=7357 vsize=871476 CPUtime=0
/proc/7369/task/7374/stat : 7374 (java) S 7357 7355 4159 34819 4229 4202560 1 0 0 0 0 0 0 0 20 0 10 0 878245065 892391424 16906 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
[pid=7369/tid=7375] ppid=7357 vsize=871476 CPUtime=0.02
/proc/7369/task/7375/stat : 7375 (java) S 7357 7355 4159 34819 4229 4202560 623 0 6 0 2 0 0 0 16 0 10 0 878245065 892391424 16906 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
[pid=7369/tid=7376] ppid=7357 vsize=871476 CPUtime=0.92
/proc/7369/task/7376/stat : 7376 (java) S 7357 7355 4159 34819 4229 4202560 7484 0 2 0 90 2 0 0 16 0 10 0 878245065 892391424 16906 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
[pid=7369/tid=7377] ppid=7357 vsize=871476 CPUtime=0
/proc/7369/task/7377/stat : 7377 (java) S 7357 7355 4159 34819 4229 4202560 1 0 0 0 0 0 0 0 21 0 10 0 878245065 892391424 16906 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
[pid=7369/tid=7378] ppid=7357 vsize=871476 CPUtime=0
/proc/7369/task/7378/stat : 7378 (java) S 7357 7355 4159 34819 4229 4202560 2 0 0 0 0 0 0 0 15 0 10 0 878245065 892391424 16906 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
Current children cumulated CPU time (s) 1.34
Current children cumulated vsize (KiB) 876624
heavy processes:

[startup+6.31928 s]
/proc/loadavg: 1.24 1.07 1.02 3/55 7378
/proc/meminfo: memFree=578076/1048576 swapFree=2077664/2097144
[pid=7355] ppid=7354 vsize=2572 CPUtime=0
/proc/7355/stat : 7355 (p2cudf-trendy-1) S 7354 7355 4159 34819 4229 4202496 375 0 0 0 0 0 0 0 24 0 1 0 878244928 2633728 272 1283457024 134512640 135304128 4290883136 18446744073709551615 4294960130 0 65536 4 65538 18446744071564329979 0 0 17 0 0 0 0
/proc/7355/statm: 643 272 233 194 0 29 0
[pid=7357] ppid=7355 vsize=2576 CPUtime=0
/proc/7357/stat : 7357 (p2cudf) S 7355 7355 4159 34819 4229 4202496 395 2855 0 132 0 0 0 0 18 0 1 0 878244928 2637824 283 1283457024 134512640 135304128 4288324544 18446744073709551615 4294960130 0 65536 4 65538 18446744071564329979 0 0 17 0 0 0 0
/proc/7357/statm: 644 283 241 194 0 30 0
[pid=7369] ppid=7357 vsize=871852 CPUtime=4.31
/proc/7369/stat : 7369 (java) S 7357 7355 4159 34819 4229 4202496 76391 0 154 0 399 32 0 0 18 0 11 0 878245002 892776448 69839 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 0 0 16800975 18446744073709551615 0 0 17 0 0 0 0
/proc/7369/statm: 217963 69839 1774 10 0 215053 0
[pid=7369/tid=7370] ppid=7357 vsize=871852 CPUtime=1.65
/proc/7369/task/7370/stat : 7370 (java) R 7357 7355 4159 34819 4229 4202560 50374 0 58 0 141 24 0 0 21 0 11 0 878245041 892776448 69839 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 0 0 0 -1 0 0 0 0
[pid=7369/tid=7371] ppid=7357 vsize=871852 CPUtime=0.33
/proc/7369/task/7371/stat : 7371 (java) S 7357 7355 4159 34819 4229 4202560 13964 0 0 0 30 3 0 0 16 0 11 0 878245053 892776448 69839 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 0 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
[pid=7369/tid=7372] ppid=7357 vsize=871852 CPUtime=0
/proc/7369/task/7372/stat : 7372 (java) S 7357 7355 4159 34819 4229 4202560 9 0 1 0 0 0 0 0 18 0 11 0 878245054 892776448 69839 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
[pid=7369/tid=7373] ppid=7357 vsize=871852 CPUtime=0
/proc/7369/task/7373/stat : 7373 (java) S 7357 7355 4159 34819 4229 4202560 6 0 0 0 0 0 0 0 18 0 11 0 878245054 892776448 69839 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
[pid=7369/tid=7374] ppid=7357 vsize=871852 CPUtime=0
/proc/7369/task/7374/stat : 7374 (java) S 7357 7355 4159 34819 4229 4202560 1 0 0 0 0 0 0 0 20 0 11 0 878245065 892776448 69839 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
[pid=7369/tid=7375] ppid=7357 vsize=871852 CPUtime=0.06
/proc/7369/task/7375/stat : 7375 (java) S 7357 7355 4159 34819 4229 4202560 627 0 6 0 6 0 0 0 15 0 11 0 878245065 892776448 69839 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
[pid=7369/tid=7376] ppid=7357 vsize=871852 CPUtime=2.25
/proc/7369/task/7376/stat : 7376 (java) S 7357 7355 4159 34819 4229 4202560 10400 0 3 0 220 5 0 0 15 0 11 0 878245065 892776448 69839 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
[pid=7369/tid=7377] ppid=7357 vsize=871852 CPUtime=0
/proc/7369/task/7377/stat : 7377 (java) S 7357 7355 4159 34819 4229 4202560 1 0 0 0 0 0 0 0 21 0 11 0 878245065 892776448 69839 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
[pid=7369/tid=7378] ppid=7357 vsize=871852 CPUtime=0
/proc/7369/task/7378/stat : 7378 (java) S 7357 7355 4159 34819 4229 4202560 2 0 0 0 0 0 0 0 15 0 11 0 878245065 892776448 69839 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
Current children cumulated CPU time (s) 4.31
Current children cumulated vsize (KiB) 877000
heavy processes:

[startup+12.7105 s]
/proc/loadavg: 1.22 1.07 1.02 2/56 7393
/proc/meminfo: memFree=542064/1048576 swapFree=2077664/2097144
[pid=7355] ppid=7354 vsize=2572 CPUtime=0
/proc/7355/stat : 7355 (p2cudf-trendy-1) S 7354 7355 4159 34819 4229 4202496 375 0 0 0 0 0 0 0 24 0 1 0 878244928 2633728 272 1283457024 134512640 135304128 4290883136 18446744073709551615 4294960130 0 65536 4 65538 18446744071564329979 0 0 17 0 0 0 0
/proc/7355/statm: 643 272 233 194 0 29 0
[pid=7357] ppid=7355 vsize=2576 CPUtime=0
/proc/7357/stat : 7357 (p2cudf) S 7355 7355 4159 34819 4229 4202496 395 2855 0 132 0 0 0 0 18 0 1 0 878244928 2637824 283 1283457024 134512640 135304128 4288324544 18446744073709551615 4294960130 0 65536 4 65538 18446744071564329979 0 0 17 0 0 0 0
/proc/7357/statm: 644 283 241 194 0 30 0
[pid=7369] ppid=7357 vsize=872500 CPUtime=10.7
/proc/7369/stat : 7369 (java) S 7357 7355 4159 34819 4229 4202496 85307 0 154 0 1034 36 0 0 18 0 11 0 878245002 893440000 78755 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 0 0 16800975 18446744073709551615 0 0 17 0 0 0 0
/proc/7369/statm: 218125 78755 1794 10 0 215215 0
[pid=7369/tid=7370] ppid=7357 vsize=872500 CPUtime=7.04
/proc/7369/task/7370/stat : 7370 (java) R 7357 7355 4159 34819 4229 4202560 50381 0 58 0 680 24 0 0 25 0 11 0 878245041 893440000 78755 1283457024 134512640 134550932 4294764672 18446744073709551615 4096099814 0 4 0 16800975 0 0 0 -1 0 0 0 0
[pid=7369/tid=7371] ppid=7357 vsize=872500 CPUtime=0.72
/proc/7369/task/7371/stat : 7371 (java) S 7357 7355 4159 34819 4229 4202560 22796 0 0 0 66 6 0 0 16 0 11 0 878245053 893440000 78755 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 0 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
[pid=7369/tid=7372] ppid=7357 vsize=872500 CPUtime=0
/proc/7369/task/7372/stat : 7372 (java) S 7357 7355 4159 34819 4229 4202560 9 0 1 0 0 0 0 0 18 0 11 0 878245054 893440000 78755 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
[pid=7369/tid=7373] ppid=7357 vsize=872500 CPUtime=0
/proc/7369/task/7373/stat : 7373 (java) S 7357 7355 4159 34819 4229 4202560 6 0 0 0 0 0 0 0 18 0 11 0 878245054 893440000 78755 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
[pid=7369/tid=7374] ppid=7357 vsize=872500 CPUtime=0
/proc/7369/task/7374/stat : 7374 (java) S 7357 7355 4159 34819 4229 4202560 1 0 0 0 0 0 0 0 20 0 11 0 878245065 893440000 78755 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
[pid=7369/tid=7375] ppid=7357 vsize=872500 CPUtime=0.06
/proc/7369/task/7375/stat : 7375 (java) S 7357 7355 4159 34819 4229 4202560 627 0 6 0 6 0 0 0 15 0 11 0 878245065 893440000 78755 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
[pid=7369/tid=7376] ppid=7357 vsize=872500 CPUtime=2.87
/proc/7369/task/7376/stat : 7376 (java) S 7357 7355 4159 34819 4229 4202560 10465 0 3 0 281 6 0 0 16 0 11 0 878245065 893440000 78755 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
[pid=7369/tid=7377] ppid=7357 vsize=872500 CPUtime=0
/proc/7369/task/7377/stat : 7377 (java) S 7357 7355 4159 34819 4229 4202560 1 0 0 0 0 0 0 0 21 0 11 0 878245065 893440000 78755 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
[pid=7369/tid=7378] ppid=7357 vsize=872500 CPUtime=0
/proc/7369/task/7378/stat : 7378 (java) S 7357 7355 4159 34819 4229 4202560 2 0 0 0 0 0 0 0 15 0 11 0 878245065 893440000 78755 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
Current children cumulated CPU time (s) 10.7
Current children cumulated vsize (KiB) 877648

[startup+25.5033 s]
/proc/loadavg: 1.17 1.07 1.01 2/56 7394
/proc/meminfo: memFree=540948/1048576 swapFree=2077664/2097144
[pid=7355] ppid=7354 vsize=2572 CPUtime=0
/proc/7355/stat : 7355 (p2cudf-trendy-1) S 7354 7355 4159 34819 4229 4202496 375 0 0 0 0 0 0 0 24 0 1 0 878244928 2633728 272 1283457024 134512640 135304128 4290883136 18446744073709551615 4294960130 0 65536 4 65538 18446744071564329979 0 0 17 0 0 0 0
/proc/7355/statm: 643 272 233 194 0 29 0
[pid=7357] ppid=7355 vsize=2576 CPUtime=0
/proc/7357/stat : 7357 (p2cudf) S 7355 7355 4159 34819 4229 4202496 395 2855 0 132 0 0 0 0 18 0 1 0 878244928 2637824 283 1283457024 134512640 135304128 4288324544 18446744073709551615 4294960130 0 65536 4 65538 18446744071564329979 0 0 17 0 0 0 0
/proc/7357/statm: 644 283 241 194 0 30 0
[pid=7369] ppid=7357 vsize=872500 CPUtime=23.48
/proc/7369/stat : 7369 (java) S 7357 7355 4159 34819 4229 4202496 85611 0 154 0 2312 36 0 0 18 0 11 0 878245002 893440000 79059 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 0 0 16800975 18446744073709551615 0 0 17 0 0 0 0
/proc/7369/statm: 218125 79059 1794 10 0 215215 0
[pid=7369/tid=7370] ppid=7357 vsize=872500 CPUtime=19.24
/proc/7369/task/7370/stat : 7370 (java) R 7357 7355 4159 34819 4229 4202560 50382 0 58 0 1900 24 0 0 25 0 11 0 878245041 893440000 79059 1283457024 134512640 134550932 4294764672 18446744073709551615 4096068196 0 4 0 16800975 0 0 0 -1 0 0 0 0
[pid=7369/tid=7371] ppid=7357 vsize=872500 CPUtime=1.26
/proc/7369/task/7371/stat : 7371 (java) S 7357 7355 4159 34819 4229 4202560 23095 0 0 0 120 6 0 0 15 0 11 0 878245053 893440000 79059 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 0 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
[pid=7369/tid=7372] ppid=7357 vsize=872500 CPUtime=0
/proc/7369/task/7372/stat : 7372 (java) S 7357 7355 4159 34819 4229 4202560 9 0 1 0 0 0 0 0 18 0 11 0 878245054 893440000 79059 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
[pid=7369/tid=7373] ppid=7357 vsize=872500 CPUtime=0
/proc/7369/task/7373/stat : 7373 (java) S 7357 7355 4159 34819 4229 4202560 6 0 0 0 0 0 0 0 15 0 11 0 878245054 893440000 79059 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
[pid=7369/tid=7374] ppid=7357 vsize=872500 CPUtime=0
/proc/7369/task/7374/stat : 7374 (java) S 7357 7355 4159 34819 4229 4202560 1 0 0 0 0 0 0 0 20 0 11 0 878245065 893440000 79059 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
[pid=7369/tid=7375] ppid=7357 vsize=872500 CPUtime=0.06
/proc/7369/task/7375/stat : 7375 (java) S 7357 7355 4159 34819 4229 4202560 627 0 6 0 6 0 0 0 15 0 11 0 878245065 893440000 79059 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
[pid=7369/tid=7376] ppid=7357 vsize=872500 CPUtime=2.9
/proc/7369/task/7376/stat : 7376 (java) S 7357 7355 4159 34819 4229 4202560 10469 0 3 0 284 6 0 0 15 0 11 0 878245065 893440000 79059 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
[pid=7369/tid=7377] ppid=7357 vsize=872500 CPUtime=0
/proc/7369/task/7377/stat : 7377 (java) S 7357 7355 4159 34819 4229 4202560 1 0 0 0 0 0 0 0 21 0 11 0 878245065 893440000 79059 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
[pid=7369/tid=7378] ppid=7357 vsize=872500 CPUtime=0
/proc/7369/task/7378/stat : 7378 (java) S 7357 7355 4159 34819 4229 4202560 2 0 0 0 0 0 0 0 15 0 11 0 878245065 893440000 79059 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
[pid=7369/tid=7394] ppid=7357 vsize=872500 CPUtime=0
/proc/7369/task/7394/stat : 7394 (java) S 7357 7355 4159 34819 4229 4202560 0 0 0 0 0 0 0 0 25 0 11 0 878246140 893440000 79059 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
Current children cumulated CPU time (s) 23.48
Current children cumulated vsize (KiB) 877648

[startup+51.1086 s]
/proc/loadavg: 1.19 1.08 1.02 2/56 7394
/proc/meminfo: memFree=540644/1048576 swapFree=2077664/2097144
[pid=7355] ppid=7354 vsize=2572 CPUtime=0
/proc/7355/stat : 7355 (p2cudf-trendy-1) S 7354 7355 4159 34819 4229 4202496 375 0 0 0 0 0 0 0 24 0 1 0 878244928 2633728 272 1283457024 134512640 135304128 4290883136 18446744073709551615 4294960130 0 65536 4 65538 18446744071564329979 0 0 17 0 0 0 0
/proc/7355/statm: 643 272 233 194 0 29 0
[pid=7357] ppid=7355 vsize=2576 CPUtime=0
/proc/7357/stat : 7357 (p2cudf) S 7355 7355 4159 34819 4229 4202496 395 2855 0 132 0 0 0 0 18 0 1 0 878244928 2637824 283 1283457024 134512640 135304128 4288324544 18446744073709551615 4294960130 0 65536 4 65538 18446744071564329979 0 0 17 0 0 0 0
/proc/7357/statm: 644 283 241 194 0 30 0
[pid=7369] ppid=7357 vsize=872500 CPUtime=49.07
/proc/7369/stat : 7369 (java) S 7357 7355 4159 34819 4229 4202496 85615 0 154 0 4871 36 0 0 18 0 11 0 878245002 893440000 79063 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 0 0 16800975 18446744073709551615 0 0 17 0 0 0 0
/proc/7369/statm: 218125 79063 1794 10 0 215215 0
[pid=7369/tid=7370] ppid=7357 vsize=872500 CPUtime=43.95
/proc/7369/task/7370/stat : 7370 (java) R 7357 7355 4159 34819 4229 4202560 50382 0 58 0 4371 24 0 0 25 0 11 0 878245041 893440000 79063 1283457024 134512640 134550932 4294764672 18446744073709551615 4096163535 0 4 0 16800975 0 0 0 -1 0 0 0 0
[pid=7369/tid=7371] ppid=7357 vsize=872500 CPUtime=2.09
/proc/7369/task/7371/stat : 7371 (java) S 7357 7355 4159 34819 4229 4202560 23095 0 0 0 203 6 0 0 15 0 11 0 878245053 893440000 79063 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 0 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
[pid=7369/tid=7372] ppid=7357 vsize=872500 CPUtime=0
/proc/7369/task/7372/stat : 7372 (java) S 7357 7355 4159 34819 4229 4202560 9 0 1 0 0 0 0 0 18 0 11 0 878245054 893440000 79063 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
[pid=7369/tid=7373] ppid=7357 vsize=872500 CPUtime=0
/proc/7369/task/7373/stat : 7373 (java) S 7357 7355 4159 34819 4229 4202560 6 0 0 0 0 0 0 0 15 0 11 0 878245054 893440000 79063 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
[pid=7369/tid=7374] ppid=7357 vsize=872500 CPUtime=0
/proc/7369/task/7374/stat : 7374 (java) S 7357 7355 4159 34819 4229 4202560 1 0 0 0 0 0 0 0 20 0 11 0 878245065 893440000 79063 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
[pid=7369/tid=7375] ppid=7357 vsize=872500 CPUtime=0.06
/proc/7369/task/7375/stat : 7375 (java) S 7357 7355 4159 34819 4229 4202560 627 0 6 0 6 0 0 0 15 0 11 0 878245065 893440000 79063 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
[pid=7369/tid=7376] ppid=7357 vsize=872500 CPUtime=2.95
/proc/7369/task/7376/stat : 7376 (java) S 7357 7355 4159 34819 4229 4202560 10473 0 3 0 289 6 0 0 15 0 11 0 878245065 893440000 79063 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
[pid=7369/tid=7377] ppid=7357 vsize=872500 CPUtime=0
/proc/7369/task/7377/stat : 7377 (java) S 7357 7355 4159 34819 4229 4202560 1 0 0 0 0 0 0 0 21 0 11 0 878245065 893440000 79063 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
[pid=7369/tid=7378] ppid=7357 vsize=872500 CPUtime=0
/proc/7369/task/7378/stat : 7378 (java) S 7357 7355 4159 34819 4229 4202560 2 0 0 0 0 0 0 0 15 0 11 0 878245065 893440000 79063 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
[pid=7369/tid=7394] ppid=7357 vsize=872500 CPUtime=0
/proc/7369/task/7394/stat : 7394 (java) S 7357 7355 4159 34819 4229 4202560 0 0 0 0 0 0 0 0 25 0 11 0 878246140 893440000 79063 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
Current children cumulated CPU time (s) 49.07
Current children cumulated vsize (KiB) 877648

[startup+102.307 s]
/proc/loadavg: 1.16 1.09 1.02 2/56 7394
/proc/meminfo: memFree=540520/1048576 swapFree=2077664/2097144
[pid=7355] ppid=7354 vsize=2572 CPUtime=0
/proc/7355/stat : 7355 (p2cudf-trendy-1) S 7354 7355 4159 34819 4229 4202496 375 0 0 0 0 0 0 0 24 0 1 0 878244928 2633728 272 1283457024 134512640 135304128 4290883136 18446744073709551615 4294960130 0 65536 4 65538 18446744071564329979 0 0 17 0 0 0 0
/proc/7355/statm: 643 272 233 194 0 29 0
[pid=7357] ppid=7355 vsize=2576 CPUtime=0
/proc/7357/stat : 7357 (p2cudf) S 7355 7355 4159 34819 4229 4202496 395 2855 0 132 0 0 0 0 18 0 1 0 878244928 2637824 283 1283457024 134512640 135304128 4288324544 18446744073709551615 4294960130 0 65536 4 65538 18446744071564329979 0 0 17 0 0 0 0
/proc/7357/statm: 644 283 241 194 0 30 0
[pid=7369] ppid=7357 vsize=872500 CPUtime=100.2
/proc/7369/stat : 7369 (java) S 7357 7355 4159 34819 4229 4202496 85615 0 154 0 9984 36 0 0 18 0 11 0 878245002 893440000 79063 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 0 0 16800975 18446744073709551615 0 0 17 0 0 0 0
/proc/7369/statm: 218125 79063 1794 10 0 215215 0
[pid=7369/tid=7370] ppid=7357 vsize=872500 CPUtime=93.74
/proc/7369/task/7370/stat : 7370 (java) R 7357 7355 4159 34819 4229 4202560 50382 0 58 0 9350 24 0 0 25 0 11 0 878245041 893440000 79063 1283457024 134512640 134550932 4294764672 18446744073709551615 4096163570 0 4 0 16800975 0 0 0 -1 0 0 0 0
[pid=7369/tid=7371] ppid=7357 vsize=872500 CPUtime=3.43
/proc/7369/task/7371/stat : 7371 (java) S 7357 7355 4159 34819 4229 4202560 23095 0 0 0 337 6 0 0 15 0 11 0 878245053 893440000 79063 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 0 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
[pid=7369/tid=7372] ppid=7357 vsize=872500 CPUtime=0
/proc/7369/task/7372/stat : 7372 (java) S 7357 7355 4159 34819 4229 4202560 9 0 1 0 0 0 0 0 18 0 11 0 878245054 893440000 79063 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
[pid=7369/tid=7373] ppid=7357 vsize=872500 CPUtime=0
/proc/7369/task/7373/stat : 7373 (java) S 7357 7355 4159 34819 4229 4202560 6 0 0 0 0 0 0 0 15 0 11 0 878245054 893440000 79063 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
[pid=7369/tid=7374] ppid=7357 vsize=872500 CPUtime=0
/proc/7369/task/7374/stat : 7374 (java) S 7357 7355 4159 34819 4229 4202560 1 0 0 0 0 0 0 0 20 0 11 0 878245065 893440000 79063 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
[pid=7369/tid=7375] ppid=7357 vsize=872500 CPUtime=0.06
/proc/7369/task/7375/stat : 7375 (java) S 7357 7355 4159 34819 4229 4202560 627 0 6 0 6 0 0 0 15 0 11 0 878245065 893440000 79063 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
[pid=7369/tid=7376] ppid=7357 vsize=872500 CPUtime=2.95
/proc/7369/task/7376/stat : 7376 (java) S 7357 7355 4159 34819 4229 4202560 10473 0 3 0 289 6 0 0 15 0 11 0 878245065 893440000 79063 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
[pid=7369/tid=7377] ppid=7357 vsize=872500 CPUtime=0
/proc/7369/task/7377/stat : 7377 (java) S 7357 7355 4159 34819 4229 4202560 1 0 0 0 0 0 0 0 21 0 11 0 878245065 893440000 79063 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
[pid=7369/tid=7378] ppid=7357 vsize=872500 CPUtime=0
/proc/7369/task/7378/stat : 7378 (java) S 7357 7355 4159 34819 4229 4202560 2 0 0 0 0 0 0 0 15 0 11 0 878245065 893440000 79063 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
[pid=7369/tid=7394] ppid=7357 vsize=872500 CPUtime=0
/proc/7369/task/7394/stat : 7394 (java) S 7357 7355 4159 34819 4229 4202560 0 0 0 0 0 0 0 0 25 0 11 0 878246140 893440000 79063 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
Current children cumulated CPU time (s) 100.2
Current children cumulated vsize (KiB) 877648

[startup+162.309 s]
/proc/loadavg: 1.17 1.10 1.03 2/56 7394
/proc/meminfo: memFree=540396/1048576 swapFree=2077664/2097144
[pid=7355] ppid=7354 vsize=2572 CPUtime=0
/proc/7355/stat : 7355 (p2cudf-trendy-1) S 7354 7355 4159 34819 4229 4202496 375 0 0 0 0 0 0 0 24 0 1 0 878244928 2633728 272 1283457024 134512640 135304128 4290883136 18446744073709551615 4294960130 0 65536 4 65538 18446744071564329979 0 0 17 0 0 0 0
/proc/7355/statm: 643 272 233 194 0 29 0
[pid=7357] ppid=7355 vsize=2576 CPUtime=0
/proc/7357/stat : 7357 (p2cudf) S 7355 7355 4159 34819 4229 4202496 395 2855 0 132 0 0 0 0 18 0 1 0 878244928 2637824 283 1283457024 134512640 135304128 4288324544 18446744073709551615 4294960130 0 65536 4 65538 18446744071564329979 0 0 17 0 0 0 0
/proc/7357/statm: 644 283 241 194 0 30 0
[pid=7369] ppid=7357 vsize=872500 CPUtime=160.14
/proc/7369/stat : 7369 (java) S 7357 7355 4159 34819 4229 4202496 85615 0 154 0 15978 36 0 0 18 0 11 0 878245002 893440000 79063 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 0 0 16800975 18446744073709551615 0 0 17 0 0 0 0
/proc/7369/statm: 218125 79063 1794 10 0 215215 0
[pid=7369/tid=7370] ppid=7357 vsize=872500 CPUtime=152.59
/proc/7369/task/7370/stat : 7370 (java) R 7357 7355 4159 34819 4229 4202560 50382 0 58 0 15235 24 0 0 25 0 11 0 878245041 893440000 79063 1283457024 134512640 134550932 4294764672 18446744073709551615 4096013015 0 4 0 16800975 0 0 0 -1 0 0 0 0
[pid=7369/tid=7371] ppid=7357 vsize=872500 CPUtime=4.53
/proc/7369/task/7371/stat : 7371 (java) S 7357 7355 4159 34819 4229 4202560 23095 0 0 0 447 6 0 0 15 0 11 0 878245053 893440000 79063 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 0 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
[pid=7369/tid=7372] ppid=7357 vsize=872500 CPUtime=0
/proc/7369/task/7372/stat : 7372 (java) S 7357 7355 4159 34819 4229 4202560 9 0 1 0 0 0 0 0 18 0 11 0 878245054 893440000 79063 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
[pid=7369/tid=7373] ppid=7357 vsize=872500 CPUtime=0
/proc/7369/task/7373/stat : 7373 (java) S 7357 7355 4159 34819 4229 4202560 6 0 0 0 0 0 0 0 15 0 11 0 878245054 893440000 79063 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
[pid=7369/tid=7374] ppid=7357 vsize=872500 CPUtime=0
/proc/7369/task/7374/stat : 7374 (java) S 7357 7355 4159 34819 4229 4202560 1 0 0 0 0 0 0 0 20 0 11 0 878245065 893440000 79063 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
[pid=7369/tid=7375] ppid=7357 vsize=872500 CPUtime=0.06
/proc/7369/task/7375/stat : 7375 (java) S 7357 7355 4159 34819 4229 4202560 627 0 6 0 6 0 0 0 15 0 11 0 878245065 893440000 79063 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
[pid=7369/tid=7376] ppid=7357 vsize=872500 CPUtime=2.95
/proc/7369/task/7376/stat : 7376 (java) S 7357 7355 4159 34819 4229 4202560 10473 0 3 0 289 6 0 0 15 0 11 0 878245065 893440000 79063 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
[pid=7369/tid=7377] ppid=7357 vsize=872500 CPUtime=0
/proc/7369/task/7377/stat : 7377 (java) S 7357 7355 4159 34819 4229 4202560 1 0 0 0 0 0 0 0 21 0 11 0 878245065 893440000 79063 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
[pid=7369/tid=7378] ppid=7357 vsize=872500 CPUtime=0
/proc/7369/task/7378/stat : 7378 (java) S 7357 7355 4159 34819 4229 4202560 2 0 0 0 0 0 0 0 15 0 11 0 878245065 893440000 79063 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
[pid=7369/tid=7394] ppid=7357 vsize=872500 CPUtime=0
/proc/7369/task/7394/stat : 7394 (java) S 7357 7355 4159 34819 4229 4202560 0 0 0 0 0 0 0 0 25 0 11 0 878246140 893440000 79063 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
Current children cumulated CPU time (s) 160.14
Current children cumulated vsize (KiB) 877648

[startup+222.312 s]
/proc/loadavg: 1.17 1.11 1.03 3/56 7394
/proc/meminfo: memFree=540148/1048576 swapFree=2077664/2097144
[pid=7355] ppid=7354 vsize=2572 CPUtime=0
/proc/7355/stat : 7355 (p2cudf-trendy-1) S 7354 7355 4159 34819 4229 4202496 375 0 0 0 0 0 0 0 24 0 1 0 878244928 2633728 272 1283457024 134512640 135304128 4290883136 18446744073709551615 4294960130 0 65536 4 65538 18446744071564329979 0 0 17 0 0 0 0
/proc/7355/statm: 643 272 233 194 0 29 0
[pid=7357] ppid=7355 vsize=2576 CPUtime=0
/proc/7357/stat : 7357 (p2cudf) S 7355 7355 4159 34819 4229 4202496 395 2855 0 132 0 0 0 0 18 0 1 0 878244928 2637824 283 1283457024 134512640 135304128 4288324544 18446744073709551615 4294960130 0 65536 4 65538 18446744071564329979 0 0 17 0 0 0 0
/proc/7357/statm: 644 283 241 194 0 30 0
[pid=7369] ppid=7357 vsize=872500 CPUtime=220.1
/proc/7369/stat : 7369 (java) S 7357 7355 4159 34819 4229 4202496 85676 0 154 0 21974 36 0 0 18 0 11 0 878245002 893440000 79124 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 0 0 16800975 18446744073709551615 0 0 17 0 0 0 0
/proc/7369/statm: 218125 79124 1794 10 0 215215 0
[pid=7369/tid=7370] ppid=7357 vsize=872500 CPUtime=211.44
/proc/7369/task/7370/stat : 7370 (java) R 7357 7355 4159 34819 4229 4202560 50382 0 58 0 21120 24 0 0 25 0 11 0 878245041 893440000 79124 1283457024 134512640 134550932 4294764672 18446744073709551615 4096222204 0 4 0 16800975 0 0 0 -1 0 0 0 0
[pid=7369/tid=7371] ppid=7357 vsize=872500 CPUtime=5.63
/proc/7369/task/7371/stat : 7371 (java) S 7357 7355 4159 34819 4229 4202560 23156 0 0 0 557 6 0 0 16 0 11 0 878245053 893440000 79124 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 0 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
[pid=7369/tid=7372] ppid=7357 vsize=872500 CPUtime=0
/proc/7369/task/7372/stat : 7372 (java) S 7357 7355 4159 34819 4229 4202560 9 0 1 0 0 0 0 0 18 0 11 0 878245054 893440000 79124 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
[pid=7369/tid=7373] ppid=7357 vsize=872500 CPUtime=0
/proc/7369/task/7373/stat : 7373 (java) S 7357 7355 4159 34819 4229 4202560 6 0 0 0 0 0 0 0 15 0 11 0 878245054 893440000 79124 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
[pid=7369/tid=7374] ppid=7357 vsize=872500 CPUtime=0
/proc/7369/task/7374/stat : 7374 (java) S 7357 7355 4159 34819 4229 4202560 1 0 0 0 0 0 0 0 20 0 11 0 878245065 893440000 79124 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
[pid=7369/tid=7375] ppid=7357 vsize=872500 CPUtime=0.06
/proc/7369/task/7375/stat : 7375 (java) S 7357 7355 4159 34819 4229 4202560 627 0 6 0 6 0 0 0 15 0 11 0 878245065 893440000 79124 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
[pid=7369/tid=7376] ppid=7357 vsize=872500 CPUtime=2.95
/proc/7369/task/7376/stat : 7376 (java) S 7357 7355 4159 34819 4229 4202560 10473 0 3 0 289 6 0 0 15 0 11 0 878245065 893440000 79124 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
[pid=7369/tid=7377] ppid=7357 vsize=872500 CPUtime=0
/proc/7369/task/7377/stat : 7377 (java) S 7357 7355 4159 34819 4229 4202560 1 0 0 0 0 0 0 0 21 0 11 0 878245065 893440000 79124 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
[pid=7369/tid=7378] ppid=7357 vsize=872500 CPUtime=0
/proc/7369/task/7378/stat : 7378 (java) S 7357 7355 4159 34819 4229 4202560 2 0 0 0 0 0 0 0 15 0 11 0 878245065 893440000 79124 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
[pid=7369/tid=7394] ppid=7357 vsize=872500 CPUtime=0
/proc/7369/task/7394/stat : 7394 (java) S 7357 7355 4159 34819 4229 4202560 0 0 0 0 0 0 0 0 25 0 11 0 878246140 893440000 79124 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
Current children cumulated CPU time (s) 220.1
Current children cumulated vsize (KiB) 877648

[startup+282.306 s]
/proc/loadavg: 1.12 1.10 1.03 2/56 7394
/proc/meminfo: memFree=540024/1048576 swapFree=2077664/2097144
[pid=7355] ppid=7354 vsize=2572 CPUtime=0
/proc/7355/stat : 7355 (p2cudf-trendy-1) S 7354 7355 4159 34819 4229 4202496 375 0 0 0 0 0 0 0 24 0 1 0 878244928 2633728 272 1283457024 134512640 135304128 4290883136 18446744073709551615 4294960130 0 65536 4 65538 18446744071564329979 0 0 17 0 0 0 0
/proc/7355/statm: 643 272 233 194 0 29 0
[pid=7357] ppid=7355 vsize=2576 CPUtime=0
/proc/7357/stat : 7357 (p2cudf) S 7355 7355 4159 34819 4229 4202496 395 2855 0 132 0 0 0 0 18 0 1 0 878244928 2637824 283 1283457024 134512640 135304128 4288324544 18446744073709551615 4294960130 0 65536 4 65538 18446744071564329979 0 0 17 0 0 0 0
/proc/7357/statm: 644 283 241 194 0 30 0
[pid=7369] ppid=7357 vsize=872500 CPUtime=280.07
/proc/7369/stat : 7369 (java) S 7357 7355 4159 34819 4229 4202496 85708 0 154 0 27971 36 0 0 18 0 11 0 878245002 893440000 79156 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 0 0 16800975 18446744073709551615 0 0 17 0 0 0 0
/proc/7369/statm: 218125 79156 1794 10 0 215215 0
[pid=7369/tid=7370] ppid=7357 vsize=872500 CPUtime=270.86
/proc/7369/task/7370/stat : 7370 (java) R 7357 7355 4159 34819 4229 4202560 50382 0 58 0 27062 24 0 0 25 0 11 0 878245041 893440000 79156 1283457024 134512640 134550932 4294764672 18446744073709551615 4096222167 0 4 0 16800975 0 0 0 -1 0 0 0 0
[pid=7369/tid=7371] ppid=7357 vsize=872500 CPUtime=6.19
/proc/7369/task/7371/stat : 7371 (java) S 7357 7355 4159 34819 4229 4202560 23188 0 0 0 613 6 0 0 15 0 11 0 878245053 893440000 79156 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 0 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
[pid=7369/tid=7372] ppid=7357 vsize=872500 CPUtime=0
/proc/7369/task/7372/stat : 7372 (java) S 7357 7355 4159 34819 4229 4202560 9 0 1 0 0 0 0 0 18 0 11 0 878245054 893440000 79156 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
[pid=7369/tid=7373] ppid=7357 vsize=872500 CPUtime=0
/proc/7369/task/7373/stat : 7373 (java) S 7357 7355 4159 34819 4229 4202560 6 0 0 0 0 0 0 0 15 0 11 0 878245054 893440000 79156 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
[pid=7369/tid=7374] ppid=7357 vsize=872500 CPUtime=0
/proc/7369/task/7374/stat : 7374 (java) S 7357 7355 4159 34819 4229 4202560 1 0 0 0 0 0 0 0 20 0 11 0 878245065 893440000 79156 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
[pid=7369/tid=7375] ppid=7357 vsize=872500 CPUtime=0.06
/proc/7369/task/7375/stat : 7375 (java) S 7357 7355 4159 34819 4229 4202560 627 0 6 0 6 0 0 0 15 0 11 0 878245065 893440000 79156 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
[pid=7369/tid=7376] ppid=7357 vsize=872500 CPUtime=2.95
/proc/7369/task/7376/stat : 7376 (java) S 7357 7355 4159 34819 4229 4202560 10473 0 3 0 289 6 0 0 15 0 11 0 878245065 893440000 79156 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
[pid=7369/tid=7377] ppid=7357 vsize=872500 CPUtime=0
/proc/7369/task/7377/stat : 7377 (java) S 7357 7355 4159 34819 4229 4202560 1 0 0 0 0 0 0 0 21 0 11 0 878245065 893440000 79156 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
[pid=7369/tid=7378] ppid=7357 vsize=872500 CPUtime=0
/proc/7369/task/7378/stat : 7378 (java) S 7357 7355 4159 34819 4229 4202560 2 0 0 0 0 0 0 0 15 0 11 0 878245065 893440000 79156 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
[pid=7369/tid=7394] ppid=7357 vsize=872500 CPUtime=0
/proc/7369/task/7394/stat : 7394 (java) S 7357 7355 4159 34819 4229 4202560 0 0 0 0 0 0 0 0 25 0 11 0 878246140 893440000 79156 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
Current children cumulated CPU time (s) 280.07
Current children cumulated vsize (KiB) 877648

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

[startup+287.907 s]
/proc/loadavg: 1.11 1.10 1.03 2/56 7394
/proc/meminfo: memFree=540024/1048576 swapFree=2077664/2097144
[pid=7355] ppid=7354 vsize=2572 CPUtime=0
/proc/7355/stat : 7355 (p2cudf-trendy-1) S 7354 7355 4159 34819 4229 4202496 375 0 0 0 0 0 0 0 24 0 1 0 878244928 2633728 272 1283457024 134512640 135304128 4290883136 18446744073709551615 4294960130 0 65536 4 65538 18446744071564329979 0 0 17 0 0 0 0
/proc/7355/statm: 643 272 233 194 0 29 0
[pid=7357] ppid=7355 vsize=2576 CPUtime=0
/proc/7357/stat : 7357 (p2cudf) S 7355 7355 4159 34819 4229 4202496 395 2855 0 132 0 0 0 0 18 0 1 0 878244928 2637824 283 1283457024 134512640 135304128 4288324544 18446744073709551615 4294960130 0 65536 4 65538 18446744071564329979 0 0 17 0 0 0 0
/proc/7357/statm: 644 283 241 194 0 30 0
[pid=7369] ppid=7357 vsize=872500 CPUtime=285.67
/proc/7369/stat : 7369 (java) S 7357 7355 4159 34819 4229 4202496 85708 0 154 0 28531 36 0 0 18 0 11 0 878245002 893440000 79156 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 0 0 16800975 18446744073709551615 0 0 17 0 0 0 0
/proc/7369/statm: 218125 79156 1794 10 0 215215 0
[pid=7369/tid=7370] ppid=7357 vsize=872500 CPUtime=276.45
/proc/7369/task/7370/stat : 7370 (java) R 7357 7355 4159 34819 4229 4202560 50382 0 58 0 27621 24 0 0 25 0 11 0 878245041 893440000 79156 1283457024 134512640 134550932 4294764672 18446744073709551615 4096222127 0 4 0 16800975 0 0 0 -1 0 0 0 0
[pid=7369/tid=7371] ppid=7357 vsize=872500 CPUtime=6.19
/proc/7369/task/7371/stat : 7371 (java) S 7357 7355 4159 34819 4229 4202560 23188 0 0 0 613 6 0 0 15 0 11 0 878245053 893440000 79156 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 0 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
[pid=7369/tid=7372] ppid=7357 vsize=872500 CPUtime=0
/proc/7369/task/7372/stat : 7372 (java) S 7357 7355 4159 34819 4229 4202560 9 0 1 0 0 0 0 0 18 0 11 0 878245054 893440000 79156 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
[pid=7369/tid=7373] ppid=7357 vsize=872500 CPUtime=0
/proc/7369/task/7373/stat : 7373 (java) S 7357 7355 4159 34819 4229 4202560 6 0 0 0 0 0 0 0 15 0 11 0 878245054 893440000 79156 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
[pid=7369/tid=7374] ppid=7357 vsize=872500 CPUtime=0
/proc/7369/task/7374/stat : 7374 (java) S 7357 7355 4159 34819 4229 4202560 1 0 0 0 0 0 0 0 20 0 11 0 878245065 893440000 79156 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
[pid=7369/tid=7375] ppid=7357 vsize=872500 CPUtime=0.06
/proc/7369/task/7375/stat : 7375 (java) S 7357 7355 4159 34819 4229 4202560 627 0 6 0 6 0 0 0 15 0 11 0 878245065 893440000 79156 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
[pid=7369/tid=7376] ppid=7357 vsize=872500 CPUtime=2.95
/proc/7369/task/7376/stat : 7376 (java) S 7357 7355 4159 34819 4229 4202560 10473 0 3 0 289 6 0 0 15 0 11 0 878245065 893440000 79156 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
[pid=7369/tid=7377] ppid=7357 vsize=872500 CPUtime=0
/proc/7369/task/7377/stat : 7377 (java) S 7357 7355 4159 34819 4229 4202560 1 0 0 0 0 0 0 0 21 0 11 0 878245065 893440000 79156 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
[pid=7369/tid=7378] ppid=7357 vsize=872500 CPUtime=0
/proc/7369/task/7378/stat : 7378 (java) S 7357 7355 4159 34819 4229 4202560 2 0 0 0 0 0 0 0 15 0 11 0 878245065 893440000 79156 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
[pid=7369/tid=7394] ppid=7357 vsize=872500 CPUtime=0
/proc/7369/task/7394/stat : 7394 (java) S 7357 7355 4159 34819 4229 4202560 0 0 0 0 0 0 0 0 25 0 11 0 878246140 893440000 79156 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
Current children cumulated CPU time (s) 285.67
Current children cumulated vsize (KiB) 877648

[startup+291.108 s]
/proc/loadavg: 1.10 1.10 1.03 2/56 7394
/proc/meminfo: memFree=540024/1048576 swapFree=2077664/2097144
[pid=7355] ppid=7354 vsize=2572 CPUtime=0
/proc/7355/stat : 7355 (p2cudf-trendy-1) S 7354 7355 4159 34819 4229 4202496 375 0 0 0 0 0 0 0 24 0 1 0 878244928 2633728 272 1283457024 134512640 135304128 4290883136 18446744073709551615 4294960130 0 65536 4 65538 18446744071564329979 0 0 17 0 0 0 0
/proc/7355/statm: 643 272 233 194 0 29 0
[pid=7357] ppid=7355 vsize=2576 CPUtime=0
/proc/7357/stat : 7357 (p2cudf) S 7355 7355 4159 34819 4229 4202496 395 2855 0 132 0 0 0 0 18 0 1 0 878244928 2637824 283 1283457024 134512640 135304128 4288324544 18446744073709551615 4294960130 0 65536 4 65538 18446744071564329979 0 0 17 0 0 0 0
/proc/7357/statm: 644 283 241 194 0 30 0
[pid=7369] ppid=7357 vsize=872500 CPUtime=288.87
/proc/7369/stat : 7369 (java) S 7357 7355 4159 34819 4229 4202496 85708 0 154 0 28851 36 0 0 18 0 11 0 878245002 893440000 79156 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 0 0 16800975 18446744073709551615 0 0 17 0 0 0 0
/proc/7369/statm: 218125 79156 1794 10 0 215215 0
[pid=7369/tid=7370] ppid=7357 vsize=872500 CPUtime=279.66
/proc/7369/task/7370/stat : 7370 (java) R 7357 7355 4159 34819 4229 4202560 50382 0 58 0 27942 24 0 0 25 0 11 0 878245041 893440000 79156 1283457024 134512640 134550932 4294764672 18446744073709551615 4096046333 0 4 0 16800975 0 0 0 -1 0 0 0 0
[pid=7369/tid=7371] ppid=7357 vsize=872500 CPUtime=6.19
/proc/7369/task/7371/stat : 7371 (java) S 7357 7355 4159 34819 4229 4202560 23188 0 0 0 613 6 0 0 15 0 11 0 878245053 893440000 79156 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 0 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
[pid=7369/tid=7372] ppid=7357 vsize=872500 CPUtime=0
/proc/7369/task/7372/stat : 7372 (java) S 7357 7355 4159 34819 4229 4202560 9 0 1 0 0 0 0 0 18 0 11 0 878245054 893440000 79156 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
[pid=7369/tid=7373] ppid=7357 vsize=872500 CPUtime=0
/proc/7369/task/7373/stat : 7373 (java) S 7357 7355 4159 34819 4229 4202560 6 0 0 0 0 0 0 0 15 0 11 0 878245054 893440000 79156 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
[pid=7369/tid=7374] ppid=7357 vsize=872500 CPUtime=0
/proc/7369/task/7374/stat : 7374 (java) S 7357 7355 4159 34819 4229 4202560 1 0 0 0 0 0 0 0 20 0 11 0 878245065 893440000 79156 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
[pid=7369/tid=7375] ppid=7357 vsize=872500 CPUtime=0.06
/proc/7369/task/7375/stat : 7375 (java) S 7357 7355 4159 34819 4229 4202560 627 0 6 0 6 0 0 0 15 0 11 0 878245065 893440000 79156 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
[pid=7369/tid=7376] ppid=7357 vsize=872500 CPUtime=2.95
/proc/7369/task/7376/stat : 7376 (java) S 7357 7355 4159 34819 4229 4202560 10473 0 3 0 289 6 0 0 15 0 11 0 878245065 893440000 79156 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
[pid=7369/tid=7377] ppid=7357 vsize=872500 CPUtime=0
/proc/7369/task/7377/stat : 7377 (java) S 7357 7355 4159 34819 4229 4202560 1 0 0 0 0 0 0 0 21 0 11 0 878245065 893440000 79156 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
[pid=7369/tid=7378] ppid=7357 vsize=872500 CPUtime=0
/proc/7369/task/7378/stat : 7378 (java) S 7357 7355 4159 34819 4229 4202560 2 0 0 0 0 0 0 0 15 0 11 0 878245065 893440000 79156 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
[pid=7369/tid=7394] ppid=7357 vsize=872500 CPUtime=0
/proc/7369/task/7394/stat : 7394 (java) S 7357 7355 4159 34819 4229 4202560 0 0 0 0 0 0 0 0 25 0 11 0 878246140 893440000 79156 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
Current children cumulated CPU time (s) 288.87
Current children cumulated vsize (KiB) 877648

[startup+291.908 s]
/proc/loadavg: 1.10 1.10 1.03 2/56 7394
/proc/meminfo: memFree=540024/1048576 swapFree=2077664/2097144
[pid=7355] ppid=7354 vsize=2572 CPUtime=0
/proc/7355/stat : 7355 (p2cudf-trendy-1) S 7354 7355 4159 34819 4229 4202496 375 0 0 0 0 0 0 0 24 0 1 0 878244928 2633728 272 1283457024 134512640 135304128 4290883136 18446744073709551615 4294960130 0 65536 4 65538 18446744071564329979 0 0 17 0 0 0 0
/proc/7355/statm: 643 272 233 194 0 29 0
[pid=7357] ppid=7355 vsize=2576 CPUtime=0
/proc/7357/stat : 7357 (p2cudf) S 7355 7355 4159 34819 4229 4202496 395 2855 0 132 0 0 0 0 18 0 1 0 878244928 2637824 283 1283457024 134512640 135304128 4288324544 18446744073709551615 4294960130 0 65536 4 65538 18446744071564329979 0 0 17 0 0 0 0
/proc/7357/statm: 644 283 241 194 0 30 0
[pid=7369] ppid=7357 vsize=872500 CPUtime=289.67
/proc/7369/stat : 7369 (java) S 7357 7355 4159 34819 4229 4202496 85968 0 154 0 28931 36 0 0 18 0 11 0 878245002 893440000 79416 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 0 0 16800975 18446744073709551615 0 0 17 0 0 0 0
/proc/7369/statm: 218125 79416 1794 10 0 215215 0
[pid=7369/tid=7370] ppid=7357 vsize=872500 CPUtime=280.18
/proc/7369/task/7370/stat : 7370 (java) R 7357 7355 4159 34819 4229 4202560 50382 0 58 0 27994 24 0 0 25 0 11 0 878245041 893440000 79416 1283457024 134512640 134550932 4294764672 18446744073709551615 4096222127 0 4 0 16800975 0 0 0 -1 0 0 0 0
[pid=7369/tid=7371] ppid=7357 vsize=872500 CPUtime=6.46
/proc/7369/task/7371/stat : 7371 (java) S 7357 7355 4159 34819 4229 4202560 23448 0 0 0 640 6 0 0 16 0 11 0 878245053 893440000 79416 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 0 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
[pid=7369/tid=7372] ppid=7357 vsize=872500 CPUtime=0
/proc/7369/task/7372/stat : 7372 (java) S 7357 7355 4159 34819 4229 4202560 9 0 1 0 0 0 0 0 18 0 11 0 878245054 893440000 79416 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
[pid=7369/tid=7373] ppid=7357 vsize=872500 CPUtime=0
/proc/7369/task/7373/stat : 7373 (java) S 7357 7355 4159 34819 4229 4202560 6 0 0 0 0 0 0 0 15 0 11 0 878245054 893440000 79416 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
[pid=7369/tid=7374] ppid=7357 vsize=872500 CPUtime=0
/proc/7369/task/7374/stat : 7374 (java) S 7357 7355 4159 34819 4229 4202560 1 0 0 0 0 0 0 0 20 0 11 0 878245065 893440000 79416 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
[pid=7369/tid=7375] ppid=7357 vsize=872500 CPUtime=0.06
/proc/7369/task/7375/stat : 7375 (java) S 7357 7355 4159 34819 4229 4202560 627 0 6 0 6 0 0 0 15 0 11 0 878245065 893440000 79416 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
[pid=7369/tid=7376] ppid=7357 vsize=872500 CPUtime=2.95
/proc/7369/task/7376/stat : 7376 (java) S 7357 7355 4159 34819 4229 4202560 10473 0 3 0 289 6 0 0 15 0 11 0 878245065 893440000 79416 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
[pid=7369/tid=7377] ppid=7357 vsize=872500 CPUtime=0
/proc/7369/task/7377/stat : 7377 (java) S 7357 7355 4159 34819 4229 4202560 1 0 0 0 0 0 0 0 21 0 11 0 878245065 893440000 79416 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
[pid=7369/tid=7378] ppid=7357 vsize=872500 CPUtime=0
/proc/7369/task/7378/stat : 7378 (java) S 7357 7355 4159 34819 4229 4202560 2 0 0 0 0 0 0 0 15 0 11 0 878245065 893440000 79416 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
[pid=7369/tid=7394] ppid=7357 vsize=872500 CPUtime=0
/proc/7369/task/7394/stat : 7394 (java) S 7357 7355 4159 34819 4229 4202560 0 0 0 0 0 0 0 0 25 0 11 0 878246140 893440000 79416 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
Current children cumulated CPU time (s) 289.67
Current children cumulated vsize (KiB) 877648

[startup+292.306 s]
/proc/loadavg: 1.10 1.10 1.03 2/56 7394
/proc/meminfo: memFree=540024/1048576 swapFree=2077664/2097144
[pid=7355] ppid=7354 vsize=2572 CPUtime=0
/proc/7355/stat : 7355 (p2cudf-trendy-1) S 7354 7355 4159 34819 4229 4202496 375 0 0 0 0 0 0 0 24 0 1 0 878244928 2633728 272 1283457024 134512640 135304128 4290883136 18446744073709551615 4294960130 0 65536 4 65538 18446744071564329979 0 0 17 0 0 0 0
/proc/7355/statm: 643 272 233 194 0 29 0
[pid=7357] ppid=7355 vsize=2576 CPUtime=0
/proc/7357/stat : 7357 (p2cudf) S 7355 7355 4159 34819 4229 4202496 395 2855 0 132 0 0 0 0 18 0 1 0 878244928 2637824 283 1283457024 134512640 135304128 4288324544 18446744073709551615 4294960130 0 65536 4 65538 18446744071564329979 0 0 17 0 0 0 0
/proc/7357/statm: 644 283 241 194 0 30 0
[pid=7369] ppid=7357 vsize=872500 CPUtime=289.95
/proc/7369/stat : 7369 (java) S 7357 7355 4159 34819 4229 4202496 85976 0 154 0 28959 36 0 0 18 0 11 0 878245002 893440000 79424 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 0 0 16800975 18446744073709551615 0 0 17 0 0 0 0
/proc/7369/statm: 218125 79424 1794 10 0 215215 0
[pid=7369/tid=7370] ppid=7357 vsize=872500 CPUtime=280.42
/proc/7369/task/7370/stat : 7370 (java) S 7357 7355 4159 34819 4229 4202560 50388 0 58 0 28018 24 0 0 25 0 11 0 878245041 893440000 79424 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
[pid=7369/tid=7371] ppid=7357 vsize=872500 CPUtime=6.46
/proc/7369/task/7371/stat : 7371 (java) S 7357 7355 4159 34819 4229 4202560 23448 0 0 0 640 6 0 0 16 0 11 0 878245053 893440000 79424 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 0 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
[pid=7369/tid=7372] ppid=7357 vsize=872500 CPUtime=0
/proc/7369/task/7372/stat : 7372 (java) S 7357 7355 4159 34819 4229 4202560 9 0 1 0 0 0 0 0 18 0 11 0 878245054 893440000 79424 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
[pid=7369/tid=7373] ppid=7357 vsize=872500 CPUtime=0
/proc/7369/task/7373/stat : 7373 (java) S 7357 7355 4159 34819 4229 4202560 6 0 0 0 0 0 0 0 15 0 11 0 878245054 893440000 79424 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
[pid=7369/tid=7374] ppid=7357 vsize=872500 CPUtime=0
/proc/7369/task/7374/stat : 7374 (java) S 7357 7355 4159 34819 4229 4202560 1 0 0 0 0 0 0 0 20 0 11 0 878245065 893440000 79424 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
[pid=7369/tid=7375] ppid=7357 vsize=872500 CPUtime=0.06
/proc/7369/task/7375/stat : 7375 (java) S 7357 7355 4159 34819 4229 4202560 627 0 6 0 6 0 0 0 15 0 11 0 878245065 893440000 79424 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
[pid=7369/tid=7376] ppid=7357 vsize=872500 CPUtime=2.99
/proc/7369/task/7376/stat : 7376 (java) S 7357 7355 4159 34819 4229 4202560 10475 0 3 0 293 6 0 0 15 0 11 0 878245065 893440000 79424 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
[pid=7369/tid=7377] ppid=7357 vsize=872500 CPUtime=0
/proc/7369/task/7377/stat : 7377 (java) S 7357 7355 4159 34819 4229 4202560 1 0 0 0 0 0 0 0 21 0 11 0 878245065 893440000 79424 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
[pid=7369/tid=7378] ppid=7357 vsize=872500 CPUtime=0
/proc/7369/task/7378/stat : 7378 (java) S 7357 7355 4159 34819 4229 4202560 2 0 0 0 0 0 0 0 15 0 11 0 878245065 893440000 79424 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
Current children cumulated CPU time (s) 289.95
Current children cumulated vsize (KiB) 877648

[startup+292.712 s]
/proc/loadavg: 1.10 1.10 1.03 1/56 7395
/proc/meminfo: memFree=538908/1048576 swapFree=2077664/2097144
[pid=7355] ppid=7354 vsize=2572 CPUtime=0
/proc/7355/stat : 7355 (p2cudf-trendy-1) S 7354 7355 4159 34819 4229 4202496 375 0 0 0 0 0 0 0 24 0 1 0 878244928 2633728 272 1283457024 134512640 135304128 4290883136 18446744073709551615 4294960130 0 65536 4 65538 18446744071564329979 0 0 17 0 0 0 0
/proc/7355/statm: 643 272 233 194 0 29 0
[pid=7357] ppid=7355 vsize=2576 CPUtime=0
/proc/7357/stat : 7357 (p2cudf) S 7355 7355 4159 34819 4229 4202496 395 2855 0 132 0 0 0 0 18 0 1 0 878244928 2637824 283 1283457024 134512640 135304128 4288324544 18446744073709551615 4294960130 0 65536 4 65538 18446744071564329979 0 0 17 0 0 0 0
/proc/7357/statm: 644 283 241 194 0 30 0
[pid=7369] ppid=7357 vsize=872500 CPUtime=289.95
/proc/7369/stat : 7369 (java) S 7357 7355 4159 34819 4229 4202496 85976 0 154 0 28959 36 0 0 18 0 11 0 878245002 893440000 79424 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 0 0 16800975 18446744073709551615 0 0 17 0 0 0 0
/proc/7369/statm: 218125 79424 1794 10 0 215215 0
[pid=7369/tid=7370] ppid=7357 vsize=872500 CPUtime=280.42
/proc/7369/task/7370/stat : 7370 (java) S 7357 7355 4159 34819 4229 4202560 50388 0 58 0 28018 24 0 0 25 0 11 0 878245041 893440000 79424 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
[pid=7369/tid=7371] ppid=7357 vsize=872500 CPUtime=6.46
/proc/7369/task/7371/stat : 7371 (java) S 7357 7355 4159 34819 4229 4202560 23448 0 0 0 640 6 0 0 15 0 11 0 878245053 893440000 79424 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 0 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
[pid=7369/tid=7372] ppid=7357 vsize=872500 CPUtime=0
/proc/7369/task/7372/stat : 7372 (java) S 7357 7355 4159 34819 4229 4202560 9 0 1 0 0 0 0 0 18 0 11 0 878245054 893440000 79424 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
[pid=7369/tid=7373] ppid=7357 vsize=872500 CPUtime=0
/proc/7369/task/7373/stat : 7373 (java) S 7357 7355 4159 34819 4229 4202560 6 0 0 0 0 0 0 0 15 0 11 0 878245054 893440000 79424 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
[pid=7369/tid=7374] ppid=7357 vsize=872500 CPUtime=0
/proc/7369/task/7374/stat : 7374 (java) S 7357 7355 4159 34819 4229 4202560 1 0 0 0 0 0 0 0 20 0 11 0 878245065 893440000 79424 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
[pid=7369/tid=7375] ppid=7357 vsize=872500 CPUtime=0.06
/proc/7369/task/7375/stat : 7375 (java) S 7357 7355 4159 34819 4229 4202560 627 0 6 0 6 0 0 0 15 0 11 0 878245065 893440000 79424 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
[pid=7369/tid=7376] ppid=7357 vsize=872500 CPUtime=2.99
/proc/7369/task/7376/stat : 7376 (java) S 7357 7355 4159 34819 4229 4202560 10475 0 3 0 293 6 0 0 15 0 11 0 878245065 893440000 79424 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
[pid=7369/tid=7377] ppid=7357 vsize=872500 CPUtime=0
/proc/7369/task/7377/stat : 7377 (java) S 7357 7355 4159 34819 4229 4202560 1 0 0 0 0 0 0 0 21 0 11 0 878245065 893440000 79424 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 18446612133086623616 0 0 -1 0 0 0 0
[pid=7369/tid=7378] ppid=7357 vsize=872500 CPUtime=0
/proc/7369/task/7378/stat : 7378 (java) R 7357 7355 4159 34819 4229 4202560 2 0 0 0 0 0 0 0 15 0 11 0 878245065 893440000 79424 1283457024 134512640 134550932 4294764672 18446744073709551615 4294960130 0 4 0 16800975 0 0 0 -1 0 0 0 0
[pid=7369/tid=7395] ppid=7357 vsize=872500 CPUtime=0
/proc/7369/task/7395/stat : 7395 (java) R 7357 7355 4159 34819 4229 4202560 0 0 0 0 0 0 0 0 20 0 11 0 878274151 893440000 79424 1283457024 134512640 134550932 4294764672 18446744073709551615 4095056964 0 4 0 16800975 0 0 0 -1 0 0 0 0
Current children cumulated CPU time (s) 289.95
Current children cumulated vsize (KiB) 877648

Child status: 0
Real time (s): 292.798
CPU time (s): 290.046
CPU user time (s): 289.638
CPU system time (s): 0.408025
CPU usage (%): 99.0602
Max. virtual memory (cumulated for all children) (KiB): 881700

getrusage(RUSAGE_CHILDREN,...) data:
user time used= 289.638
system time used= 0.408025
maximum resident set size= 0
integral shared memory size= 0
integral unshared data size= 0
integral unshared stack size= 0
page reclaims= 89625
page faults= 286
swaps= 0
block input operations= 0
block output operations= 0
messages sent= 0
messages received= 0
signals received= 0
voluntary context switches= 7304
involuntary context switches= 9376

runsolver used 0.004 second user time and 0 second system time

The end