2025-08-19T15:45:28.632: current working dir: /root/qa/mctester.
2025-08-19T15:45:29.213: current logging dir: ../mctester/www.
2025-08-19T15:45:29.213: ---------------------------------------------------------------
2025-08-19T15:45:29.295: mctester entry: 2025-08-19T15:45:29.215771 mode=50
2025-08-19T15:45:29.296: ---------------------------------------------------------------
2025-08-19T15:45:31.074: EXE: 1/git describe --tags.
2025-08-19T15:45:34.072: Row 1: v1.1-402-g456a81f.
2025-08-19T15:45:34.075: EXE: 1/git rev-list --count HEAD.
2025-08-19T15:45:34.179: Row 1: 459.
2025-08-19T15:45:34.182: EXE: 1/git rev-parse HEAD.
2025-08-19T15:45:34.192: Row 1: 456a81f64caf35b3feed720cc72a7640341dd873.
2025-08-19T15:45:34.259: mctester: v1.1.459 (456a81f64caf35b3feed720cc72a7640341dd873).
2025-08-19T15:45:34.301: Entering into a performance tests mode.
2025-08-19T15:45:34.302: ------ test: start, 2025-08-19T15:45:34.301
2025-08-19T15:45:34.342: ------ test: 2000
2025-08-19T15:45:34.343: CMD: ssh -o ServerAliveInterval=60 -o ServerAliveCountMax=3 root@megatron.headai.com "top -b -n 1"
2025-08-19T15:45:34.357: EXE: 1/ssh -o ServerAliveInterval=60 -o ServerAliveCountMax=3 root@megatron.headai.com "top -b -n 1".
2025-08-19T15:45:34.641: Row 1: top - 15:45:34 up 79 days, 5:33, 1 user, load average: 0.11, 0.34, 0.36.
2025-08-19T15:45:34.642: Row 2: Tasks: 523 total, 1 running, 522 sleeping, 0 stopped, 0 zombie.
2025-08-19T15:45:34.643: Row 3: %Cpu(s): 1.7 us, 0.2 sy, 0.0 ni, 98.1 id, 0.0 wa, 0.0 hi, 0.0 si, 0.0 st.
2025-08-19T15:45:34.643: Row 4: KiB Mem : 13202036+total, 681988 free, 67595544 used, 63742840 buff/cache.
2025-08-19T15:45:34.643: Row 5: KiB Swap: 0 total, 0 free, 0 used. 63434428 avail Mem .
2025-08-19T15:45:34.646: Row 6: .
2025-08-19T15:45:34.647: Row 7: PID USER PR NI VIRT RES SHR S %CPU %MEM TIME+ COMMAND.
2025-08-19T15:45:34.648: Row 8: 2224 mysql 20 0 0.171t 0.076t 0.027t S 43.8 61.5 8405:21 mysqld.
2025-08-19T15:45:34.648: Row 9: 96989 root 20 0 25.483g 0.013t 34132 S 6.2 10.8 83864:12 java.
2025-08-19T15:45:34.648: Row 10: 116077 root 20 0 44056 4088 3188 R 6.2 0.0 0:00.01 top.
2025-08-19T15:45:34.653: Row 11: 1 root 20 0 43692 3716 2352 S 0.0 0.0 3:53.29 init.
2025-08-19T15:45:34.653: Row 12: 2 root 20 0 0 0 0 S 0.0 0.0 0:00.77 kthreadd.
2025-08-19T15:45:34.654: Row 13: 3 root 20 0 0 0 0 S 0.0 0.0 0:19.09 ksoftirqd+.
2025-08-19T15:45:34.654: Row 14: 4 root 20 0 0 0 0 S 0.0 0.0 0:00.00 kworker/0+.
2025-08-19T15:45:34.654: Row 15: 5 root 0 -20 0 0 0 S 0.0 0.0 0:00.00 kworker/0+.
2025-08-19T15:45:34.659: Row 16: 7 root 20 0 0 0 0 S 0.0 0.0 33:57.28 rcu_sched.
2025-08-19T15:45:34.659: Row 17: 8 root 20 0 0 0 0 S 0.0 0.0 0:00.00 rcu_bh.
2025-08-19T15:45:34.660: Row 18: 9 root rt 0 0 0 0 S 0.0 0.0 0:01.56 migration+.
2025-08-19T15:45:34.660: Row 19: 10 root rt 0 0 0 0 S 0.0 0.0 0:19.30 watchdog/0.
2025-08-19T15:45:34.660: Row 20: 11 root rt 0 0 0 0 S 0.0 0.0 0:18.72 watchdog/1.
2025-08-19T15:45:34.678: Row 21: 12 root rt 0 0 0 0 S 0.0 0.0 0:06.17 migration+.
2025-08-19T15:45:34.679: Row 22: 13 root 20 0 0 0 0 S 0.0 0.0 0:01.45 ksoftirqd+.
2025-08-19T15:45:34.679: Row 23: 14 root 20 0 0 0 0 S 0.0 0.0 0:00.00 kworker/1+.
2025-08-19T15:45:34.682: Row 24: 15 root 0 -20 0 0 0 S 0.0 0.0 0:00.00 kworker/1+.
2025-08-19T15:45:34.948: SUC: 579ms Uptime 79 days, 1min 0.11, 5min 0.34, 15min 0.36, mem:132020360 total / 681988 free / 67595544 used / 63742840 cache / 63434428 avail
2025-08-19T15:45:35.101: ------ test: 2001
2025-08-19T15:45:35.102: CMD: top -b -E k -n 1
2025-08-19T15:45:35.104: EXE: 1/top -b -E k -n 1.
2025-08-19T15:45:35.429: Row 1: top - 15:45:35 up 5 days, 5:07, 0 users, load average: 48.84, 58.55, 46.02.
2025-08-19T15:45:35.429: Row 2: Tasks: 150 total, 1 running, 148 sleeping, 0 stopped, 1 zombie.
2025-08-19T15:45:35.430: Row 3: %Cpu(s):100.0 us, 0.0 sy, 0.0 ni, 0.0 id, 0.0 wa, 0.0 hi, 0.0 si, 0.0 st.
2025-08-19T15:45:35.430: Row 4: KiB Mem : 1907544 total, 167508 free, 1215512 used, 524524 buff/cache.
2025-08-19T15:45:35.430: Row 5: KiB Swap: 0 total, 0 free, 0 used. 509228 avail Mem .
2025-08-19T15:45:35.430: Row 6: .
2025-08-19T15:45:35.430: Row 7: PID USER PR NI VIRT RES SHR S %CPU %MEM TIME+ COMMAND.
2025-08-19T15:45:35.430: Row 8: 235982 root 20 0 4128592 83460 27324 S 81.2 4.4 0:01.20 java.
2025-08-19T15:45:35.431: Row 9: 236037 root 20 0 32416 19460 8992 D 6.2 1.0 0:00.06 python3.
2025-08-19T15:45:35.431: Row 10: 236045 root 20 0 20576 8900 5832 D 6.2 0.5 0:00.01 python3.
2025-08-19T15:45:35.431: Row 11: 1 root 20 0 167744 10960 6204 S 0.0 0.6 1:32.57 systemd.
2025-08-19T15:45:35.431: Row 12: 2 root 20 0 0 0 0 S 0.0 0.0 0:00.03 kthreadd.
2025-08-19T15:45:35.433: Row 13: 3 root 0 -20 0 0 0 I 0.0 0.0 0:00.00 rcu_gp.
2025-08-19T15:45:35.433: Row 14: 4 root 0 -20 0 0 0 I 0.0 0.0 0:00.00 rcu_par+.
2025-08-19T15:45:35.433: Row 15: 5 root 0 -20 0 0 0 I 0.0 0.0 0:00.00 slub_fl+.
2025-08-19T15:45:35.433: Row 16: 6 root 0 -20 0 0 0 I 0.0 0.0 0:00.00 netns.
2025-08-19T15:45:35.434: Row 17: 8 root 0 -20 0 0 0 I 0.0 0.0 0:00.00 kworker+.
2025-08-19T15:45:35.434: Row 18: 10 root 0 -20 0 0 0 I 0.0 0.0 0:00.00 mm_perc+.
2025-08-19T15:45:35.434: Row 19: 11 root 20 0 0 0 0 S 0.0 0.0 0:00.00 rcu_tas+.
2025-08-19T15:45:35.434: Row 20: 12 root 20 0 0 0 0 S 0.0 0.0 0:00.00 rcu_tas+.
2025-08-19T15:45:35.434: Row 21: 13 root 20 0 0 0 0 S 0.0 0.0 0:06.02 ksoftir+.
2025-08-19T15:45:35.434: Row 22: 14 root 20 0 0 0 0 I 0.0 0.0 0:12.94 rcu_sch+.
2025-08-19T15:45:35.435: Row 23: 15 root rt 0 0 0 0 S 0.0 0.0 0:01.07 migrati+.
2025-08-19T15:45:35.435: Row 24: 16 root -51 0 0 0 0 S 0.0 0.0 0:00.00 idle_in+.
2025-08-19T15:45:35.458: ERR: 356ms Uptime 5 days, 1min 48.84, 5min 58.55, 15min 46.02, mem:1907544 total / 167508 free / 1215512 used / 524524 cache / 509228 avail
2025-08-19T15:45:35.481: ------ test: 2002
2025-08-19T15:45:35.483: CMD: df -h
2025-08-19T15:45:35.484: EXE: 1/df -h.
2025-08-19T15:45:35.562: Row 1: Filesystem Size Used Avail Use% Mounted on.
2025-08-19T15:45:35.562: Row 2: tmpfs 187M 20M 167M 11% /run.
2025-08-19T15:45:35.563: Row 3: /dev/vda2 30G 21G 7.6G 74% /.
2025-08-19T15:45:35.563: Row 4: tmpfs 932M 0 932M 0% /dev/shm.
2025-08-19T15:45:35.563: Row 5: tmpfs 5.0M 0 5.0M 0% /run/lock.
2025-08-19T15:45:35.589: SUC: 107ms Diskfree qa.headai.com: tmpfs:11%, /dev/vda2:74%, tmpfs:0%, tmpfs:0%.
2025-08-19T15:45:35.590: ------ test: 2003
2025-08-19T15:45:35.590: CMD: ssh -o ServerAliveInterval=60 -o ServerAliveCountMax=3 root@megatron.headai.com "df -h"
2025-08-19T15:45:35.590: EXE: 1/ssh -o ServerAliveInterval=60 -o ServerAliveCountMax=3 root@megatron.headai.com "df -h".
2025-08-19T15:45:35.699: Row 1: Filesystem Size Used Avail Use% Mounted on.
2025-08-19T15:45:35.700: Row 2: udev 63G 4.0K 63G 1% /dev.
2025-08-19T15:45:35.700: Row 3: tmpfs 13G 5.5M 13G 1% /run.
2025-08-19T15:45:35.700: Row 4: /dev/vda1 757G 652G 75G 90% /.
2025-08-19T15:45:35.700: Row 5: none 4.0K 0 4.0K 0% /sys/fs/cgroup.
2025-08-19T15:45:35.700: Row 6: none 5.0M 0 5.0M 0% /run/lock.
2025-08-19T15:45:35.700: Row 7: none 63G 0 63G 0% /run/shm.
2025-08-19T15:45:35.701: Row 8: none 100M 0 100M 0% /run/user.
2025-08-19T15:45:35.701: Row 9: cgmfs 100K 0 100K 0% /run/cgmanager/fs.
2025-08-19T15:45:35.701: Row 10: /dev/vdb 985G 271G 664G 29% /opt/tomcat/webapps/ROOT/analysis.
2025-08-19T15:45:35.701: Row 11: tmpfs 100K 0 100K 0% /var/lib/lxd/shmounts.
2025-08-19T15:45:35.705: Row 12: tmpfs 100K 0 100K 0% /var/lib/lxd/devlxd.
2025-08-19T15:45:35.708: SUC: 118ms Diskfree megatron.headai.com: udev:1%, tmpfs:1%, /dev/vda1:90%, none:0%, none:0%, none:0%, none:0%, cgmfs:0%, /dev/vdb:29%, tmpfs:0%, tmpfs:0%.
2025-08-19T15:45:35.708: ------ test: 2004
2025-08-19T15:45:35.709: URL: https://headai.com
2025-08-19T15:45:43.520: SUC: 7746ms, meets direction. Headai is a deep tech company enabling Decision Intelligence for future-focused organizations through automated analysis of unstructured text data. Unlock Hidden Insights Optimize Workforce Strategies Enable Decision Intelligence Improve Operational Efficiency Metis Training tool for creating machine-readable data Learn how to create high-quality, machine-readable data for better job recommendations and labor market […]" />, length 200971.
2025-08-19T15:45:43.522: ------ test: 2005
2025-08-19T15:45:49.170: SQL: show global status like 'threads_connected';.
2025-08-19T15:45:49.283: Results: value=1/200.
2025-08-19T15:45:49.294: SQL: value, lines: 1, ret=1, 1.
2025-08-19T15:45:49.296: SUC: 5774ms 1
2025-08-19T15:45:49.303: ------ test: 2006
2025-08-19T15:45:49.435: SQL: SHOW PROCESSLIST;.
2025-08-19T15:45:49.448: Row 1: 29314350,root,localhost:39334,null,Query,0,starting,SHOW PROCESSLIST.
2025-08-19T15:45:49.448: SQL: COUNTNOTLINES:Command, lines: 1, ret=1, 1.
2025-08-19T15:45:49.449: SUC: 145ms 1
2025-08-19T15:45:49.451: checkJavaStack starting: 2007.
2025-08-19T15:45:49.965: ------ test: 2007
2025-08-19T15:45:49.971: EXE: 5/"jstack 96989 | awk '/nid=/ {if (in_block && has_h1_h2) {for (i = start_line; i <= last_h1_h2; i++) print lines[i]} start_line = NR; last_h1_h2 = 0; has_h1_h2 = 0; in_block = 1} /h1|h2/ {has_h1_h2 = 1; last_h1_h2 = NR} {lines[NR] = $0} END {if (in_block && has_h1_h2) {for (i = start_line; i <= last_h1_h2; i++) print lines[i]}}' || true".
2025-08-19T15:45:50.269: SUC: 2007, 298ms, lines: 4096.
2025-08-19T15:45:50.271: checkJavaStack end: 2007, pid/ret=4096.
2025-08-19T15:46:00.280: checkJavaStack starting: 2007.
2025-08-19T15:46:00.637: ------ test: 2007
2025-08-19T15:46:00.638: EXE: 5/"jstack 96989 | awk '/nid=/ {if (in_block && has_h1_h2) {for (i = start_line; i <= last_h1_h2; i++) print lines[i]} start_line = NR; last_h1_h2 = 0; has_h1_h2 = 0; in_block = 1} /h1|h2/ {has_h1_h2 = 1; last_h1_h2 = NR} {lines[NR] = $0} END {if (in_block && has_h1_h2) {for (i = start_line; i <= last_h1_h2; i++) print lines[i]}}' || true".
2025-08-19T15:46:00.905: SUC: 2007, 267ms, lines: 4096.
2025-08-19T15:46:00.906: checkJavaStack end: 2007, pid/ret=4096.
2025-08-19T15:46:10.906: checkJavaStack starting: 2007.
2025-08-19T15:46:10.993: ------ test: 2007
2025-08-19T15:46:10.994: EXE: 5/"jstack 96989 | awk '/nid=/ {if (in_block && has_h1_h2) {for (i = start_line; i <= last_h1_h2; i++) print lines[i]} start_line = NR; last_h1_h2 = 0; has_h1_h2 = 0; in_block = 1} /h1|h2/ {has_h1_h2 = 1; last_h1_h2 = NR} {lines[NR] = $0} END {if (in_block && has_h1_h2) {for (i = start_line; i <= last_h1_h2; i++) print lines[i]}}' || true".
2025-08-19T15:46:11.227: Row 1: "https-openssl-nio-443-exec-6303" #2916697 daemon prio=5 os_prio=0 tid=0x00007efc3c51b000 nid=0x1a69e runnable [0x00007efc15cda000].
2025-08-19T15:46:11.228: Row 2: java.lang.Thread.State: RUNNABLE.
2025-08-19T15:46:11.231: Row 3: at h2.compass_3.calculate_MATCH(compass_3.java:474).
2025-08-19T15:46:11.231: Row 4: at h2.compass_3.get_recommendations(compass_3.java:318).
2025-08-19T15:46:11.232: Row 5: at h2.Compass.doPost(Compass.java:125).
2025-08-19T15:46:11.235: SUC: 2007, 241ms, lines: 5.
2025-08-19T15:46:11.235: checkJavaStack end: 2007, pid/ret=5.
2025-08-19T15:46:21.238: checkJavaStack starting: 2007.
2025-08-19T15:46:21.354: ------ test: 2007
2025-08-19T15:46:21.354: EXE: 5/"jstack 96989 | awk '/nid=/ {if (in_block && has_h1_h2) {for (i = start_line; i <= last_h1_h2; i++) print lines[i]} start_line = NR; last_h1_h2 = 0; has_h1_h2 = 0; in_block = 1} /h1|h2/ {has_h1_h2 = 1; last_h1_h2 = NR} {lines[NR] = $0} END {if (in_block && has_h1_h2) {for (i = start_line; i <= last_h1_h2; i++) print lines[i]}}' || true".
2025-08-19T15:46:21.586: SUC: 2007, 232ms, lines: 4096.
2025-08-19T15:46:21.586: checkJavaStack end: 2007, pid/ret=4096.
2025-08-19T15:46:31.587: checkJavaStack starting: 2007.
2025-08-19T15:46:31.702: ------ test: 2007
2025-08-19T15:46:31.702: EXE: 5/"jstack 96989 | awk '/nid=/ {if (in_block && has_h1_h2) {for (i = start_line; i <= last_h1_h2; i++) print lines[i]} start_line = NR; last_h1_h2 = 0; has_h1_h2 = 0; in_block = 1} /h1|h2/ {has_h1_h2 = 1; last_h1_h2 = NR} {lines[NR] = $0} END {if (in_block && has_h1_h2) {for (i = start_line; i <= last_h1_h2; i++) print lines[i]}}' || true".
2025-08-19T15:46:31.942: SUC: 2007, 240ms, lines: 4096.
2025-08-19T15:46:31.942: checkJavaStack end: 2007, pid/ret=4096.
2025-08-19T15:46:41.943: checkJavaStack starting: 2007.
2025-08-19T15:46:42.030: ------ test: 2007
2025-08-19T15:46:42.030: EXE: 5/"jstack 96989 | awk '/nid=/ {if (in_block && has_h1_h2) {for (i = start_line; i <= last_h1_h2; i++) print lines[i]} start_line = NR; last_h1_h2 = 0; has_h1_h2 = 0; in_block = 1} /h1|h2/ {has_h1_h2 = 1; last_h1_h2 = NR} {lines[NR] = $0} END {if (in_block && has_h1_h2) {for (i = start_line; i <= last_h1_h2; i++) print lines[i]}}' || true".
2025-08-19T15:46:42.288: SUC: 2007, 258ms, lines: 4096.
2025-08-19T15:46:42.288: checkJavaStack end: 2007, pid/ret=4096.
2025-08-19T15:46:52.289: checkJavaStack starting: 2007.
2025-08-19T15:46:52.373: ------ test: 2007
2025-08-19T15:46:52.373: EXE: 5/"jstack 96989 | awk '/nid=/ {if (in_block && has_h1_h2) {for (i = start_line; i <= last_h1_h2; i++) print lines[i]} start_line = NR; last_h1_h2 = 0; has_h1_h2 = 0; in_block = 1} /h1|h2/ {has_h1_h2 = 1; last_h1_h2 = NR} {lines[NR] = $0} END {if (in_block && has_h1_h2) {for (i = start_line; i <= last_h1_h2; i++) print lines[i]}}' || true".
2025-08-19T15:46:52.601: SUC: 2007, 228ms, lines: 4096.
2025-08-19T15:46:52.602: checkJavaStack end: 2007, pid/ret=4096.
2025-08-19T15:47:02.602: checkJavaStack starting: 2007.
2025-08-19T15:47:02.692: ------ test: 2007
2025-08-19T15:47:02.692: EXE: 5/"jstack 96989 | awk '/nid=/ {if (in_block && has_h1_h2) {for (i = start_line; i <= last_h1_h2; i++) print lines[i]} start_line = NR; last_h1_h2 = 0; has_h1_h2 = 0; in_block = 1} /h1|h2/ {has_h1_h2 = 1; last_h1_h2 = NR} {lines[NR] = $0} END {if (in_block && has_h1_h2) {for (i = start_line; i <= last_h1_h2; i++) print lines[i]}}' || true".
2025-08-19T15:47:02.967: SUC: 2007, 275ms, lines: 4096.
2025-08-19T15:47:02.968: checkJavaStack end: 2007, pid/ret=4096.
2025-08-19T15:47:12.968: checkJavaStack starting: 2007.
2025-08-19T15:47:13.154: ------ test: 2007
2025-08-19T15:47:13.155: EXE: 5/"jstack 96989 | awk '/nid=/ {if (in_block && has_h1_h2) {for (i = start_line; i <= last_h1_h2; i++) print lines[i]} start_line = NR; last_h1_h2 = 0; has_h1_h2 = 0; in_block = 1} /h1|h2/ {has_h1_h2 = 1; last_h1_h2 = NR} {lines[NR] = $0} END {if (in_block && has_h1_h2) {for (i = start_line; i <= last_h1_h2; i++) print lines[i]}}' || true".
2025-08-19T15:47:13.488: SUC: 2007, 333ms, lines: 4096.
2025-08-19T15:47:13.557: checkJavaStack end: 2007, pid/ret=4096.
2025-08-19T15:47:23.557: checkJavaStack starting: 2007.
2025-08-19T15:47:23.650: ------ test: 2007
2025-08-19T15:47:23.650: EXE: 5/"jstack 96989 | awk '/nid=/ {if (in_block && has_h1_h2) {for (i = start_line; i <= last_h1_h2; i++) print lines[i]} start_line = NR; last_h1_h2 = 0; has_h1_h2 = 0; in_block = 1} /h1|h2/ {has_h1_h2 = 1; last_h1_h2 = NR} {lines[NR] = $0} END {if (in_block && has_h1_h2) {for (i = start_line; i <= last_h1_h2; i++) print lines[i]}}' || true".
2025-08-19T15:47:23.868: SUC: 2007, 218ms, lines: 4096.
2025-08-19T15:47:23.869: checkJavaStack end: 2007, pid/ret=4096.
2025-08-19T15:47:33.884: checkJavaStack starting: 2007.
2025-08-19T15:47:34.398: ------ test: 2007
2025-08-19T15:47:34.398: EXE: 5/"jstack 96989 | awk '/nid=/ {if (in_block && has_h1_h2) {for (i = start_line; i <= last_h1_h2; i++) print lines[i]} start_line = NR; last_h1_h2 = 0; has_h1_h2 = 0; in_block = 1} /h1|h2/ {has_h1_h2 = 1; last_h1_h2 = NR} {lines[NR] = $0} END {if (in_block && has_h1_h2) {for (i = start_line; i <= last_h1_h2; i++) print lines[i]}}' || true".
2025-08-19T15:47:34.678: SUC: 2007, 280ms, lines: 4096.
2025-08-19T15:47:34.681: checkJavaStack end: 2007, pid/ret=4096.
2025-08-19T15:47:44.681: checkJavaStack starting: 2007.
2025-08-19T15:47:44.785: ------ test: 2007
2025-08-19T15:47:44.786: EXE: 5/"jstack 96989 | awk '/nid=/ {if (in_block && has_h1_h2) {for (i = start_line; i <= last_h1_h2; i++) print lines[i]} start_line = NR; last_h1_h2 = 0; has_h1_h2 = 0; in_block = 1} /h1|h2/ {has_h1_h2 = 1; last_h1_h2 = NR} {lines[NR] = $0} END {if (in_block && has_h1_h2) {for (i = start_line; i <= last_h1_h2; i++) print lines[i]}}' || true".
2025-08-19T15:47:45.014: SUC: 2007, 228ms, lines: 4096.
2025-08-19T15:47:45.014: checkJavaStack end: 2007, pid/ret=4096.
2025-08-19T15:47:55.014: checkJavaStack starting: 2007.
2025-08-19T15:47:55.113: ------ test: 2007
2025-08-19T15:47:55.113: EXE: 5/"jstack 96989 | awk '/nid=/ {if (in_block && has_h1_h2) {for (i = start_line; i <= last_h1_h2; i++) print lines[i]} start_line = NR; last_h1_h2 = 0; has_h1_h2 = 0; in_block = 1} /h1|h2/ {has_h1_h2 = 1; last_h1_h2 = NR} {lines[NR] = $0} END {if (in_block && has_h1_h2) {for (i = start_line; i <= last_h1_h2; i++) print lines[i]}}' || true".
2025-08-19T15:47:55.348: SUC: 2007, 235ms, lines: 4096.
2025-08-19T15:47:55.349: checkJavaStack end: 2007, pid/ret=4096.
2025-08-19T15:48:05.349: checkJavaStack starting: 2007.
2025-08-19T15:48:05.434: ------ test: 2007
2025-08-19T15:48:05.434: EXE: 5/"jstack 96989 | awk '/nid=/ {if (in_block && has_h1_h2) {for (i = start_line; i <= last_h1_h2; i++) print lines[i]} start_line = NR; last_h1_h2 = 0; has_h1_h2 = 0; in_block = 1} /h1|h2/ {has_h1_h2 = 1; last_h1_h2 = NR} {lines[NR] = $0} END {if (in_block && has_h1_h2) {for (i = start_line; i <= last_h1_h2; i++) print lines[i]}}' || true".
2025-08-19T15:48:05.665: SUC: 2007, 231ms, lines: 4096.
2025-08-19T15:48:05.666: checkJavaStack end: 2007, pid/ret=4096.
2025-08-19T15:48:15.669: checkJavaStack starting: 2007.
2025-08-19T15:48:15.770: ------ test: 2007
2025-08-19T15:48:15.770: EXE: 5/"jstack 96989 | awk '/nid=/ {if (in_block && has_h1_h2) {for (i = start_line; i <= last_h1_h2; i++) print lines[i]} start_line = NR; last_h1_h2 = 0; has_h1_h2 = 0; in_block = 1} /h1|h2/ {has_h1_h2 = 1; last_h1_h2 = NR} {lines[NR] = $0} END {if (in_block && has_h1_h2) {for (i = start_line; i <= last_h1_h2; i++) print lines[i]}}' || true".
2025-08-19T15:48:16.000: SUC: 2007, 230ms, lines: 4096.
2025-08-19T15:48:16.001: checkJavaStack end: 2007, pid/ret=4096.
2025-08-19T15:48:26.001: checkJavaStack starting: 2007.
2025-08-19T15:48:26.087: ------ test: 2007
2025-08-19T15:48:26.088: EXE: 5/"jstack 96989 | awk '/nid=/ {if (in_block && has_h1_h2) {for (i = start_line; i <= last_h1_h2; i++) print lines[i]} start_line = NR; last_h1_h2 = 0; has_h1_h2 = 0; in_block = 1} /h1|h2/ {has_h1_h2 = 1; last_h1_h2 = NR} {lines[NR] = $0} END {if (in_block && has_h1_h2) {for (i = start_line; i <= last_h1_h2; i++) print lines[i]}}' || true".
2025-08-19T15:48:26.354: SUC: 2007, 266ms, lines: 4096.
2025-08-19T15:48:26.355: checkJavaStack end: 2007, pid/ret=4096.
2025-08-19T15:48:36.355: checkJavaStack starting: 2007.
2025-08-19T15:48:36.470: ------ test: 2007
2025-08-19T15:48:36.470: EXE: 5/"jstack 96989 | awk '/nid=/ {if (in_block && has_h1_h2) {for (i = start_line; i <= last_h1_h2; i++) print lines[i]} start_line = NR; last_h1_h2 = 0; has_h1_h2 = 0; in_block = 1} /h1|h2/ {has_h1_h2 = 1; last_h1_h2 = NR} {lines[NR] = $0} END {if (in_block && has_h1_h2) {for (i = start_line; i <= last_h1_h2; i++) print lines[i]}}' || true".
2025-08-19T15:48:36.747: SUC: 2007, 277ms, lines: 4096.
2025-08-19T15:48:36.747: checkJavaStack end: 2007, pid/ret=4096.
2025-08-19T15:48:46.747: checkJavaStack starting: 2007.
2025-08-19T15:48:46.833: ------ test: 2007
2025-08-19T15:48:46.833: EXE: 5/"jstack 96989 | awk '/nid=/ {if (in_block && has_h1_h2) {for (i = start_line; i <= last_h1_h2; i++) print lines[i]} start_line = NR; last_h1_h2 = 0; has_h1_h2 = 0; in_block = 1} /h1|h2/ {has_h1_h2 = 1; last_h1_h2 = NR} {lines[NR] = $0} END {if (in_block && has_h1_h2) {for (i = start_line; i <= last_h1_h2; i++) print lines[i]}}' || true".
2025-08-19T15:48:47.015: SUC: 2007, 182ms, lines: 4096.
2025-08-19T15:48:47.016: checkJavaStack end: 2007, pid/ret=4096.
2025-08-19T15:48:57.016: checkJavaStack starting: 2007.
2025-08-19T15:48:57.102: ------ test: 2007
2025-08-19T15:48:57.102: EXE: 5/"jstack 96989 | awk '/nid=/ {if (in_block && has_h1_h2) {for (i = start_line; i <= last_h1_h2; i++) print lines[i]} start_line = NR; last_h1_h2 = 0; has_h1_h2 = 0; in_block = 1} /h1|h2/ {has_h1_h2 = 1; last_h1_h2 = NR} {lines[NR] = $0} END {if (in_block && has_h1_h2) {for (i = start_line; i <= last_h1_h2; i++) print lines[i]}}' || true".
2025-08-19T15:48:57.348: SUC: 2007, 246ms, lines: 4096.
2025-08-19T15:48:57.349: checkJavaStack end: 2007, pid/ret=4096.
2025-08-19T15:49:07.349: checkJavaStack starting: 2007.
2025-08-19T15:49:07.439: ------ test: 2007
2025-08-19T15:49:07.439: EXE: 5/"jstack 96989 | awk '/nid=/ {if (in_block && has_h1_h2) {for (i = start_line; i <= last_h1_h2; i++) print lines[i]} start_line = NR; last_h1_h2 = 0; has_h1_h2 = 0; in_block = 1} /h1|h2/ {has_h1_h2 = 1; last_h1_h2 = NR} {lines[NR] = $0} END {if (in_block && has_h1_h2) {for (i = start_line; i <= last_h1_h2; i++) print lines[i]}}' || true".
2025-08-19T15:49:07.648: SUC: 2007, 209ms, lines: 4096.
2025-08-19T15:49:07.649: checkJavaStack end: 2007, pid/ret=4096.
2025-08-19T15:49:17.649: checkJavaStack starting: 2007.
2025-08-19T15:49:17.746: ------ test: 2007
2025-08-19T15:49:17.746: EXE: 5/"jstack 96989 | awk '/nid=/ {if (in_block && has_h1_h2) {for (i = start_line; i <= last_h1_h2; i++) print lines[i]} start_line = NR; last_h1_h2 = 0; has_h1_h2 = 0; in_block = 1} /h1|h2/ {has_h1_h2 = 1; last_h1_h2 = NR} {lines[NR] = $0} END {if (in_block && has_h1_h2) {for (i = start_line; i <= last_h1_h2; i++) print lines[i]}}' || true".
2025-08-19T15:49:18.011: SUC: 2007, 265ms, lines: 4096.
2025-08-19T15:49:18.012: checkJavaStack end: 2007, pid/ret=4096.
2025-08-19T15:49:28.012: checkJavaStack starting: 2007.
2025-08-19T15:49:28.097: ------ test: 2007
2025-08-19T15:49:28.097: EXE: 5/"jstack 96989 | awk '/nid=/ {if (in_block && has_h1_h2) {for (i = start_line; i <= last_h1_h2; i++) print lines[i]} start_line = NR; last_h1_h2 = 0; has_h1_h2 = 0; in_block = 1} /h1|h2/ {has_h1_h2 = 1; last_h1_h2 = NR} {lines[NR] = $0} END {if (in_block && has_h1_h2) {for (i = start_line; i <= last_h1_h2; i++) print lines[i]}}' || true".
2025-08-19T15:49:28.314: SUC: 2007, 216ms, lines: 4096.
2025-08-19T15:49:28.314: checkJavaStack end: 2007, pid/ret=4096.
2025-08-19T15:49:38.314: checkJavaStack starting: 2007.
2025-08-19T15:49:38.434: ------ test: 2007
2025-08-19T15:49:38.434: EXE: 5/"jstack 96989 | awk '/nid=/ {if (in_block && has_h1_h2) {for (i = start_line; i <= last_h1_h2; i++) print lines[i]} start_line = NR; last_h1_h2 = 0; has_h1_h2 = 0; in_block = 1} /h1|h2/ {has_h1_h2 = 1; last_h1_h2 = NR} {lines[NR] = $0} END {if (in_block && has_h1_h2) {for (i = start_line; i <= last_h1_h2; i++) print lines[i]}}' || true".
2025-08-19T15:49:38.679: SUC: 2007, 245ms, lines: 4096.
2025-08-19T15:49:38.680: checkJavaStack end: 2007, pid/ret=4096.
2025-08-19T15:49:48.680: checkJavaStack starting: 2007.
2025-08-19T15:49:48.765: ------ test: 2007
2025-08-19T15:49:48.765: EXE: 5/"jstack 96989 | awk '/nid=/ {if (in_block && has_h1_h2) {for (i = start_line; i <= last_h1_h2; i++) print lines[i]} start_line = NR; last_h1_h2 = 0; has_h1_h2 = 0; in_block = 1} /h1|h2/ {has_h1_h2 = 1; last_h1_h2 = NR} {lines[NR] = $0} END {if (in_block && has_h1_h2) {for (i = start_line; i <= last_h1_h2; i++) print lines[i]}}' || true".
2025-08-19T15:49:48.993: SUC: 2007, 228ms, lines: 4096.
2025-08-19T15:49:49.045: checkJavaStack end: 2007, pid/ret=4096.
2025-08-19T15:49:59.045: checkJavaStack starting: 2007.
2025-08-19T15:49:59.132: ------ test: 2007
2025-08-19T15:49:59.132: EXE: 5/"jstack 96989 | awk '/nid=/ {if (in_block && has_h1_h2) {for (i = start_line; i <= last_h1_h2; i++) print lines[i]} start_line = NR; last_h1_h2 = 0; has_h1_h2 = 0; in_block = 1} /h1|h2/ {has_h1_h2 = 1; last_h1_h2 = NR} {lines[NR] = $0} END {if (in_block && has_h1_h2) {for (i = start_line; i <= last_h1_h2; i++) print lines[i]}}' || true".
2025-08-19T15:49:59.378: SUC: 2007, 246ms, lines: 4096.
2025-08-19T15:49:59.379: checkJavaStack end: 2007, pid/ret=4096.
2025-08-19T15:50:09.379: checkJavaStack starting: 2007.
2025-08-19T15:50:09.494: ------ test: 2007
2025-08-19T15:50:09.494: EXE: 5/"jstack 96989 | awk '/nid=/ {if (in_block && has_h1_h2) {for (i = start_line; i <= last_h1_h2; i++) print lines[i]} start_line = NR; last_h1_h2 = 0; has_h1_h2 = 0; in_block = 1} /h1|h2/ {has_h1_h2 = 1; last_h1_h2 = NR} {lines[NR] = $0} END {if (in_block && has_h1_h2) {for (i = start_line; i <= last_h1_h2; i++) print lines[i]}}' || true".
2025-08-19T15:50:09.732: SUC: 2007, 238ms, lines: 4096.
2025-08-19T15:50:09.733: checkJavaStack end: 2007, pid/ret=4096.
2025-08-19T15:50:19.733: checkJavaStack starting: 2007.
2025-08-19T15:50:19.824: ------ test: 2007
2025-08-19T15:50:19.824: EXE: 5/"jstack 96989 | awk '/nid=/ {if (in_block && has_h1_h2) {for (i = start_line; i <= last_h1_h2; i++) print lines[i]} start_line = NR; last_h1_h2 = 0; has_h1_h2 = 0; in_block = 1} /h1|h2/ {has_h1_h2 = 1; last_h1_h2 = NR} {lines[NR] = $0} END {if (in_block && has_h1_h2) {for (i = start_line; i <= last_h1_h2; i++) print lines[i]}}' || true".
2025-08-19T15:50:20.021: SUC: 2007, 197ms, lines: 4096.
2025-08-19T15:50:20.021: checkJavaStack end: 2007, pid/ret=4096.
2025-08-19T15:50:30.021: checkJavaStack starting: 2007.
2025-08-19T15:50:30.109: ------ test: 2007
2025-08-19T15:50:30.109: EXE: 5/"jstack 96989 | awk '/nid=/ {if (in_block && has_h1_h2) {for (i = start_line; i <= last_h1_h2; i++) print lines[i]} start_line = NR; last_h1_h2 = 0; has_h1_h2 = 0; in_block = 1} /h1|h2/ {has_h1_h2 = 1; last_h1_h2 = NR} {lines[NR] = $0} END {if (in_block && has_h1_h2) {for (i = start_line; i <= last_h1_h2; i++) print lines[i]}}' || true".
2025-08-19T15:50:30.310: SUC: 2007, 201ms, lines: 4096.
2025-08-19T15:50:30.310: checkJavaStack end: 2007, pid/ret=4096.
2025-08-19T15:50:40.313: checkJavaStack starting: 2007.
2025-08-19T15:50:40.430: ------ test: 2007
2025-08-19T15:50:40.430: EXE: 5/"jstack 96989 | awk '/nid=/ {if (in_block && has_h1_h2) {for (i = start_line; i <= last_h1_h2; i++) print lines[i]} start_line = NR; last_h1_h2 = 0; has_h1_h2 = 0; in_block = 1} /h1|h2/ {has_h1_h2 = 1; last_h1_h2 = NR} {lines[NR] = $0} END {if (in_block && has_h1_h2) {for (i = start_line; i <= last_h1_h2; i++) print lines[i]}}' || true".
2025-08-19T15:50:40.634: SUC: 2007, 204ms, lines: 4096.
2025-08-19T15:50:40.635: checkJavaStack end: 2007, pid/ret=4096.
2025-08-19T15:50:50.635: checkJavaStack starting: 2007.
2025-08-19T15:50:50.721: ------ test: 2007
2025-08-19T15:50:50.721: EXE: 5/"jstack 96989 | awk '/nid=/ {if (in_block && has_h1_h2) {for (i = start_line; i <= last_h1_h2; i++) print lines[i]} start_line = NR; last_h1_h2 = 0; has_h1_h2 = 0; in_block = 1} /h1|h2/ {has_h1_h2 = 1; last_h1_h2 = NR} {lines[NR] = $0} END {if (in_block && has_h1_h2) {for (i = start_line; i <= last_h1_h2; i++) print lines[i]}}' || true".
2025-08-19T15:50:50.953: SUC: 2007, 232ms, lines: 4096.
2025-08-19T15:50:50.954: checkJavaStack end: 2007, pid/ret=4096.
2025-08-19T15:51:00.954: checkJavaStack starting: 2007.
2025-08-19T15:51:01.049: ------ test: 2007
2025-08-19T15:51:01.050: EXE: 5/"jstack 96989 | awk '/nid=/ {if (in_block && has_h1_h2) {for (i = start_line; i <= last_h1_h2; i++) print lines[i]} start_line = NR; last_h1_h2 = 0; has_h1_h2 = 0; in_block = 1} /h1|h2/ {has_h1_h2 = 1; last_h1_h2 = NR} {lines[NR] = $0} END {if (in_block && has_h1_h2) {for (i = start_line; i <= last_h1_h2; i++) print lines[i]}}' || true".
2025-08-19T15:51:01.281: SUC: 2007, 231ms, lines: 4096.
2025-08-19T15:51:01.282: checkJavaStack end: 2007, pid/ret=4096.
2025-08-19T15:51:11.282: checkJavaStack starting: 2007.
2025-08-19T15:51:11.373: ------ test: 2007
2025-08-19T15:51:11.373: EXE: 5/"jstack 96989 | awk '/nid=/ {if (in_block && has_h1_h2) {for (i = start_line; i <= last_h1_h2; i++) print lines[i]} start_line = NR; last_h1_h2 = 0; has_h1_h2 = 0; in_block = 1} /h1|h2/ {has_h1_h2 = 1; last_h1_h2 = NR} {lines[NR] = $0} END {if (in_block && has_h1_h2) {for (i = start_line; i <= last_h1_h2; i++) print lines[i]}}' || true".
2025-08-19T15:51:11.629: SUC: 2007, 256ms, lines: 4096.
2025-08-19T15:51:11.630: checkJavaStack end: 2007, pid/ret=4096.
2025-08-19T15:51:11.636: ------ test: end, 337329ms. Score 39/38.
2025-08-19T15:51:11.645: Test duration: 5m37s.