Edit D:\app\Administrator\diag\rdbms\orcl\orcl\trace\cdmp_20250517100704\orcl_w000_12848_bucket.trc
Trace file d:\app\administrator\diag\rdbms\orcl\orcl\trace\cdmp_20250517100704\orcl_w000_12848_bucket.trc Oracle Database 11g Enterprise Edition Release 11.2.0.1.0 - 64bit Production With the Partitioning, OLAP, Data Mining and Real Application Testing options Windows NT Version V6.2 CPU : 32 - type 8664, 16 Physical Cores Process Affinity : 0x0x0000000000000000 Memory (Avail/Total): Ph:37360M/63366M, Ph+PgF:44567M/72582M Instance name: orcl Redo thread mounted by this instance: 1 Oracle process number: 22 Windows thread id: 12848, image: ORACLE.EXE (W000) *** 2025-05-17 10:07:04.144 *** SESSION ID:(177.12099) 2025-05-17 10:07:04.144 *** 2025-05-17 10:07:04.144 Process diagnostic dump for ORACLE.EXE (W000), OS id=12848, pid: 22, proc_ser: 96, sid: 177, sess_ser: 12099 ------------------------------------------------------------------------------- current sql: <none> Current Wait Stack: 0: waiting for 'Space Manager: slave idle wait' Slave ID=0x0, =0x0, =0x0 wait_id=11 seq_num=12 snap_id=1 wait times: snap=1.288780 sec, exc=1.288780 sec, total=1.288780 sec wait times: max=5.000000 sec, heur=51.356156 sec wait counts: calls=1 os=1 in_wait=1 iflags=0x5a8 Wait State: fixed_waits=0 flags=0x22 boundary=0x0000000000000000/-1 Session Wait History: elapsed time of 0.000025 sec since current wait 0: waited for 'Space Manager: slave idle wait' Slave ID=0x0, =0x0, =0x0 wait_id=10 seq_num=11 snap_id=1 wait times: snap=5.000282 sec, exc=5.000282 sec, total=5.000282 sec wait times: max=5.000000 sec wait counts: calls=1 os=1 occurred after 0.000024 sec of elapsed time 1: waited for 'Space Manager: slave idle wait' Slave ID=0x0, =0x0, =0x0 wait_id=9 seq_num=10 snap_id=1 wait times: snap=5.013917 sec, exc=5.013917 sec, total=5.013917 sec wait times: max=5.000000 sec wait counts: calls=1 os=1 occurred after 0.000023 sec of elapsed time 2: waited for 'Space Manager: slave idle wait' Slave ID=0x0, =0x0, =0x0 wait_id=8 seq_num=9 snap_id=1 wait times: snap=5.010454 sec, exc=5.010454 sec, total=5.010454 sec wait times: max=5.000000 sec wait counts: calls=1 os=1 occurred after 0.000022 sec of elapsed time 3: waited for 'Space Manager: slave idle wait' Slave ID=0x0, =0x0, =0x0 wait_id=7 seq_num=8 snap_id=1 wait times: snap=5.009205 sec, exc=5.009205 sec, total=5.009205 sec wait times: max=5.000000 sec wait counts: calls=1 os=1 occurred after 0.000024 sec of elapsed time 4: waited for 'Space Manager: slave idle wait' Slave ID=0x0, =0x0, =0x0 wait_id=6 seq_num=7 snap_id=1 wait times: snap=5.010162 sec, exc=5.010162 sec, total=5.010162 sec wait times: max=5.000000 sec wait counts: calls=1 os=1 occurred after 0.000025 sec of elapsed time 5: waited for 'Space Manager: slave idle wait' Slave ID=0x0, =0x0, =0x0 wait_id=5 seq_num=6 snap_id=1 wait times: snap=5.009752 sec, exc=5.009752 sec, total=5.009752 sec wait times: max=5.000000 sec wait counts: calls=1 os=1 occurred after 0.000023 sec of elapsed time 6: waited for 'Space Manager: slave idle wait' Slave ID=0x0, =0x0, =0x0 wait_id=4 seq_num=5 snap_id=1 wait times: snap=5.003212 sec, exc=5.003212 sec, total=5.003212 sec wait times: max=5.000000 sec wait counts: calls=1 os=1 occurred after 0.000031 sec of elapsed time 7: waited for 'Space Manager: slave idle wait' Slave ID=0x0, =0x0, =0x0 wait_id=3 seq_num=4 snap_id=1 wait times: snap=5.000489 sec, exc=5.000489 sec, total=5.000489 sec wait times: max=5.000000 sec wait counts: calls=1 os=1 occurred after 0.000025 sec of elapsed time 8: waited for 'Space Manager: slave idle wait' Slave ID=0x0, =0x0, =0x0 wait_id=2 seq_num=3 snap_id=1 wait times: snap=5.010848 sec, exc=5.010848 sec, total=5.010848 sec wait times: max=5.000000 sec wait counts: calls=1 os=1 occurred after 0.000023 sec of elapsed time 9: waited for 'Space Manager: slave idle wait' Slave ID=0x0, =0x0, =0x0 wait_id=1 seq_num=2 snap_id=1 wait times: snap=4.998810 sec, exc=4.998810 sec, total=4.998810 sec wait times: max=5.000000 sec wait counts: calls=1 os=1 occurred after 0.004096 sec of elapsed time Sampled Session History of session 177 serial 12099 --------------------------------------------------- The sampled session history is constructed by sampling the target session every 1 second. The sampling process captures at each sample if the session is in a non-idle wait, an idle wait, or not in a wait. If the session is in a non-idle wait then one interval is shown for all the samples the session was in the same non-idle wait. If the session is in an idle wait or not in a wait for consecutive samples then one interval is shown for all the consecutive samples. Though we display these consecutive samples in a single interval the session may NOT be continuously idle or not in a wait (the sampling process does not know). The history is displayed in reverse chronological order. sample interval: 1 sec, max history 120 sec --------------------------------------------------- [52 samples, 10:06:12 - 10:07:04] idle wait at each sample [session created at: 10:06:12] ------------------------------------------------------------------------------- Process diagnostic dump actual duration=0.000000 sec (max dump time=30.000000 sec) *** 2025-05-17 10:07:04.144 ------------------------------------------------------------------------------- Trace Bucket Dump Begin: default bucket for process 22 (osid: 12848, W000) TIME(*=approx):SEQ:COMPONENT:FILE@LINE:FUNCTION:SECT/DUMP: [EVENT#:PID:SID] DATA ------------------------------------------------------------------------------- 2025-05-17 07:55:54.790311 :9832FC2A:db_trace:kso.c@4117:ksonfy(): [10420:22:0] kso: spawn diagnostics: post dbkc time=0 secs 2025-05-17 07:55:54.790840 :9832FC2B:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:22:177] KSL POST SENT postee=23 loc='kso2.h LINE:416 ID:ksoreq_reply' id1=0 id2=0 name= type=0 2025-05-17 07:55:54.790898 :9832FC32:db_trace:ksl2.c@12699:ksliwat(): [10005:22:177] KSL POST RCVD poster=23 loc='ksv2.h LINE:1639 ID:ksvpst: run' id1=0 id2=0 name= type=0 fac#=0 facpost=1 2025-05-17 08:05:55.729205 :9833CA34:db_trace:kst.c@698:kstpsodel(): [10280:22:0] kst: process state object about to be deleted 2025-05-17 08:05:56.108844 :9833CA76:db_trace:kst.c@673:kstipg(): [10280:22:0] kst: process state object created on 05-17 08:05:56.104 2025-05-17 08:05:56.108846 :9833CA77:db_trace:kst.c@679:kstipg(): [10280:22:0] kst: process info: ospid=14036 pso_num=22 pso_serial#=81 2025-05-17 08:05:56.108983 :9833CA78:db_trace:kso.c@4093:ksonfy(): [10420:22:0] kso: new process: pid=14036 osp_idx=0 osp_ver=202296 osp_pg=0 (spawn #190568) 2025-05-17 08:05:56.108984 :9833CA79:db_trace:kso.c@4099:ksonfy(): [10420:22:0] kso: new process: first_req_pid=1236 spawner_pid=3660 sga_crt_ts=x8A8A 2025-05-17 08:05:56.108984 :9833CA7A:db_trace:kso.c@4103:ksonfy(): [10420:22:0] kso: new process: pso_index=22 reservation=246 time=444965985 2025-05-17 08:05:56.108984 :9833CA7B:db_trace:kso.c@4109:ksonfy(): [10420:22:0] kso: spawn diagnostics: queue time=0 secs 2025-05-17 08:05:56.108985 :9833CA7C:db_trace:kso.c@4111:ksonfy(): [10420:22:0] kso: spawn diagnostics: fork time=0 secs 2025-05-17 08:05:56.108985 :9833CA7D:db_trace:kso.c@4113:ksonfy(): [10420:22:0] kso: spawn diagnostics: exec time=0 secs 2025-05-17 08:05:56.108985 :9833CA7E:db_trace:kso.c@4115:ksonfy(): [10420:22:0] kso: spawn diagnostics: pre dbkc time=0 secs 2025-05-17 08:05:56.108985 :9833CA7F:db_trace:kso.c@4117:ksonfy(): [10420:22:0] kso: spawn diagnostics: post dbkc time=0 secs 2025-05-17 08:05:56.109476 :9833CA80:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:22:177] KSL POST SENT postee=23 loc='kso2.h LINE:416 ID:ksoreq_reply' id1=0 id2=0 name= type=0 2025-05-17 08:05:56.109522 :9833CA88:db_trace:ksl2.c@12699:ksliwat(): [10005:22:177] KSL POST RCVD poster=23 loc='ksv2.h LINE:1639 ID:ksvpst: run' id1=0 id2=0 name= type=0 fac#=0 facpost=1 2025-05-17 08:15:57.090099 :983491FA:db_trace:kst.c@698:kstpsodel(): [10280:22:0] kst: process state object about to be deleted 2025-05-17 08:15:57.423283 :9834924E:db_trace:kst.c@673:kstipg(): [10280:22:0] kst: process state object created on 05-17 08:15:57.418 2025-05-17 08:15:57.423285 :9834924F:db_trace:kst.c@679:kstipg(): [10280:22:0] kst: process info: ospid=12152 pso_num=22 pso_serial#=82 2025-05-17 08:15:57.423417 :98349250:db_trace:kso.c@4093:ksonfy(): [10420:22:0] kso: new process: pid=12152 osp_idx=0 osp_ver=202297 osp_pg=0 (spawn #190590) 2025-05-17 08:15:57.423417 :98349251:db_trace:kso.c@4099:ksonfy(): [10420:22:0] kso: new process: first_req_pid=1236 spawner_pid=3660 sga_crt_ts=x8A8A 2025-05-17 08:15:57.423418 :98349252:db_trace:kso.c@4103:ksonfy(): [10420:22:0] kso: new process: pso_index=22 reservation=247 time=445567297 2025-05-17 08:15:57.423418 :98349253:db_trace:kso.c@4109:ksonfy(): [10420:22:0] kso: spawn diagnostics: queue time=0 secs 2025-05-17 08:15:57.423419 :98349254:db_trace:kso.c@4111:ksonfy(): [10420:22:0] kso: spawn diagnostics: fork time=0 secs 2025-05-17 08:15:57.423419 :98349255:db_trace:kso.c@4113:ksonfy(): [10420:22:0] kso: spawn diagnostics: exec time=0 secs 2025-05-17 08:15:57.423419 :98349256:db_trace:kso.c@4115:ksonfy(): [10420:22:0] kso: spawn diagnostics: pre dbkc time=0 secs 2025-05-17 08:15:57.423420 :98349257:db_trace:kso.c@4117:ksonfy(): [10420:22:0] kso: spawn diagnostics: post dbkc time=0 secs 2025-05-17 08:15:57.423974 :98349258:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:22:177] KSL POST SENT postee=23 loc='kso2.h LINE:416 ID:ksoreq_reply' id1=0 id2=0 name= type=0 2025-05-17 08:15:57.424047 :9834925F:db_trace:ksl2.c@12699:ksliwat(): [10005:22:177] KSL POST RCVD poster=23 loc='ksv2.h LINE:1639 ID:ksvpst: run' id1=0 id2=0 name= type=0 fac#=0 facpost=1 2025-05-17 08:25:58.468317 :9835577E:db_trace:kst.c@698:kstpsodel(): [10280:22:0] kst: process state object about to be deleted 2025-05-17 08:25:58.769845 :983557C2:db_trace:kst.c@673:kstipg(): [10280:22:0] kst: process state object created on 05-17 08:25:58.765 2025-05-17 08:25:58.769847 :983557C3:db_trace:kst.c@679:kstipg(): [10280:22:0] kst: process info: ospid=14144 pso_num=22 pso_serial#=83 2025-05-17 08:25:58.769971 :983557C4:db_trace:kso.c@4093:ksonfy(): [10420:22:0] kso: new process: pid=14144 osp_idx=0 osp_ver=202298 osp_pg=0 (spawn #190613) 2025-05-17 08:25:58.769972 :983557C5:db_trace:kso.c@4099:ksonfy(): [10420:22:0] kso: new process: first_req_pid=1236 spawner_pid=3660 sga_crt_ts=x8A8A 2025-05-17 08:25:58.769972 :983557C6:db_trace:kso.c@4103:ksonfy(): [10420:22:0] kso: new process: pso_index=22 reservation=248 time=446168641 2025-05-17 08:25:58.769973 :983557C7:db_trace:kso.c@4109:ksonfy(): [10420:22:0] kso: spawn diagnostics: queue time=0 secs 2025-05-17 08:25:58.769973 :983557C8:db_trace:kso.c@4111:ksonfy(): [10420:22:0] kso: spawn diagnostics: fork time=0 secs 2025-05-17 08:25:58.769973 :983557C9:db_trace:kso.c@4113:ksonfy(): [10420:22:0] kso: spawn diagnostics: exec time=0 secs 2025-05-17 08:25:58.769974 :983557CA:db_trace:kso.c@4115:ksonfy(): [10420:22:0] kso: spawn diagnostics: pre dbkc time=0 secs 2025-05-17 08:25:58.769974 :983557CB:db_trace:kso.c@4117:ksonfy(): [10420:22:0] kso: spawn diagnostics: post dbkc time=0 secs 2025-05-17 08:25:58.770469 :983557CC:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:22:177] KSL POST SENT postee=23 loc='kso2.h LINE:416 ID:ksoreq_reply' id1=0 id2=0 name= type=0 2025-05-17 08:25:58.770511 :983557D3:db_trace:ksl2.c@12699:ksliwat(): [10005:22:177] KSL POST RCVD poster=23 loc='ksv2.h LINE:1639 ID:ksvpst: run' id1=0 id2=0 name= type=0 fac#=0 facpost=1 2025-05-17 08:35:59.661746 :98361EB6:db_trace:kst.c@698:kstpsodel(): [10280:22:0] kst: process state object about to be deleted 2025-05-17 08:35:59.799628 :98361EB9:db_trace:kst.c@673:kstipg(): [10280:22:0] kst: process state object created on 05-17 08:35:59.786 2025-05-17 08:35:59.799631 :98361EBA:db_trace:kst.c@679:kstipg(): [10280:22:0] kst: process info: ospid=8672 pso_num=22 pso_serial#=84 2025-05-17 08:35:59.799768 :98361EBB:db_trace:kso.c@4070:ksonfy(): [10420:22:0] kso: new process: pid=8672 (legacy spawn) 2025-05-17 08:35:59.806154 :98361EBC:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:22:177] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-05-17 08:35:59.806323 :98361EC1:db_trace:ksl2.c@12699:ksliwat(): [10005:22:177] KSL POST RCVD poster=14 loc='ksl2.h LINE:2165 ID:kslpsr' id1=134 id2=0 name=EV type=0 fac#=0 facpost=1 2025-05-17 08:35:59.807118 :98361EC6:db_trace:kst.c@698:kstpsodel(): [10280:22:0] kst: process state object about to be deleted 2025-05-17 08:35:59.815703 :98361EC9:db_trace:kst.c@673:kstipg(): [10280:22:0] kst: process state object created on 05-17 08:35:59.802 2025-05-17 08:35:59.815705 :98361ECA:db_trace:kst.c@679:kstipg(): [10280:22:0] kst: process info: ospid=10124 pso_num=22 pso_serial#=85 2025-05-17 08:35:59.815841 :98361ECB:db_trace:kso.c@4070:ksonfy(): [10420:22:0] kso: new process: pid=10124 (legacy spawn) 2025-05-17 08:35:59.822210 :98361ECC:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:22:177] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-05-17 08:35:59.822240 :98361ECF:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:22:177] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-05-17 08:35:59.822384 :98361ED6:db_trace:ksl2.c@12699:ksliwat(): [10005:22:177] KSL POST RCVD poster=14 loc='ksl2.h LINE:2165 ID:kslpsr' id1=134 id2=0 name=EV type=0 fac#=0 facpost=1 2025-05-17 08:35:59.823208 :98361EE3:db_trace:kst.c@698:kstpsodel(): [10280:22:0] kst: process state object about to be deleted 2025-05-17 08:36:00.166161 :98361F33:db_trace:kst.c@673:kstipg(): [10280:22:0] kst: process state object created on 05-17 08:36:00.161 2025-05-17 08:36:00.166163 :98361F34:db_trace:kst.c@679:kstipg(): [10280:22:0] kst: process info: ospid=12136 pso_num=22 pso_serial#=86 2025-05-17 08:36:00.166294 :98361F35:db_trace:kso.c@4093:ksonfy(): [10420:22:0] kso: new process: pid=12136 osp_idx=0 osp_ver=202301 osp_pg=0 (spawn #190637) 2025-05-17 08:36:00.166294 :98361F36:db_trace:kso.c@4099:ksonfy(): [10420:22:0] kso: new process: first_req_pid=1236 spawner_pid=3660 sga_crt_ts=x8A8A 2025-05-17 08:36:00.166294 :98361F37:db_trace:kso.c@4103:ksonfy(): [10420:22:0] kso: new process: pso_index=22 reservation=249 time=446770032 2025-05-17 08:36:00.166295 :98361F38:db_trace:kso.c@4109:ksonfy(): [10420:22:0] kso: spawn diagnostics: queue time=0 secs 2025-05-17 08:36:00.166295 :98361F39:db_trace:kso.c@4111:ksonfy(): [10420:22:0] kso: spawn diagnostics: fork time=0 secs 2025-05-17 08:36:00.166295 :98361F3A:db_trace:kso.c@4113:ksonfy(): [10420:22:0] kso: spawn diagnostics: exec time=0 secs 2025-05-17 08:36:00.166296 :98361F3B:db_trace:kso.c@4115:ksonfy(): [10420:22:0] kso: spawn diagnostics: pre dbkc time=0 secs 2025-05-17 08:36:00.166296 :98361F3C:db_trace:kso.c@4117:ksonfy(): [10420:22:0] kso: spawn diagnostics: post dbkc time=0 secs 2025-05-17 08:36:00.166779 :98361F3D:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:22:177] KSL POST SENT postee=23 loc='kso2.h LINE:416 ID:ksoreq_reply' id1=0 id2=0 name= type=0 2025-05-17 08:36:00.166827 :98361F46:db_trace:ksl2.c@12699:ksliwat(): [10005:22:177] KSL POST RCVD poster=23 loc='ksv2.h LINE:1639 ID:ksvpst: run' id1=0 id2=0 name= type=0 fac#=0 facpost=1 2025-05-17 08:46:01.122810 :9836E51F:db_trace:kst.c@698:kstpsodel(): [10280:22:0] kst: process state object about to be deleted 2025-05-17 08:46:01.564881 :9836E62C:db_trace:kst.c@673:kstipg(): [10280:22:0] kst: process state object created on 05-17 08:46:01.560 2025-05-17 08:46:01.564883 :9836E62D:db_trace:kst.c@679:kstipg(): [10280:22:0] kst: process info: ospid=10096 pso_num=22 pso_serial#=87 2025-05-17 08:46:01.565034 :9836E62E:db_trace:kso.c@4093:ksonfy(): [10420:22:0] kso: new process: pid=10096 osp_idx=0 osp_ver=202302 osp_pg=0 (spawn #190659) 2025-05-17 08:46:01.565035 :9836E62F:db_trace:kso.c@4099:ksonfy(): [10420:22:0] kso: new process: first_req_pid=1236 spawner_pid=3660 sga_crt_ts=x8A8A 2025-05-17 08:46:01.565035 :9836E630:db_trace:kso.c@4103:ksonfy(): [10420:22:0] kso: new process: pso_index=22 reservation=250 time=447371438 2025-05-17 08:46:01.565035 :9836E631:db_trace:kso.c@4109:ksonfy(): [10420:22:0] kso: spawn diagnostics: queue time=0 secs 2025-05-17 08:46:01.565036 :9836E632:db_trace:kso.c@4111:ksonfy(): [10420:22:0] kso: spawn diagnostics: fork time=0 secs 2025-05-17 08:46:01.565036 :9836E633:db_trace:kso.c@4113:ksonfy(): [10420:22:0] kso: spawn diagnostics: exec time=0 secs 2025-05-17 08:46:01.565036 :9836E634:db_trace:kso.c@4115:ksonfy(): [10420:22:0] kso: spawn diagnostics: pre dbkc time=0 secs 2025-05-17 08:46:01.565037 :9836E635:db_trace:kso.c@4117:ksonfy(): [10420:22:0] kso: spawn diagnostics: post dbkc time=0 secs 2025-05-17 08:46:01.565572 :9836E636:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:22:177] KSL POST SENT postee=23 loc='kso2.h LINE:416 ID:ksoreq_reply' id1=0 id2=0 name= type=0 2025-05-17 08:46:01.565616 :9836E63D:db_trace:ksl2.c@12699:ksliwat(): [10005:22:177] KSL POST RCVD poster=23 loc='ksv2.h LINE:1639 ID:ksvpst: run' id1=0 id2=0 name= type=0 fac#=0 facpost=1 2025-05-17 08:56:02.463875 :9837ABD0:db_trace:kst.c@698:kstpsodel(): [10280:22:0] kst: process state object about to be deleted 2025-05-17 08:56:02.953019 :9837AC47:db_trace:kst.c@673:kstipg(): [10280:22:0] kst: process state object created on 05-17 08:56:02.948 2025-05-17 08:56:02.953021 :9837AC48:db_trace:kst.c@679:kstipg(): [10280:22:0] kst: process info: ospid=11216 pso_num=22 pso_serial#=88 2025-05-17 08:56:02.953160 :9837AC49:db_trace:kso.c@4093:ksonfy(): [10420:22:0] kso: new process: pid=11216 osp_idx=0 osp_ver=202303 osp_pg=0 (spawn #190682) 2025-05-17 08:56:02.953161 :9837AC4A:db_trace:kso.c@4099:ksonfy(): [10420:22:0] kso: new process: first_req_pid=1236 spawner_pid=3660 sga_crt_ts=x8A8A 2025-05-17 08:56:02.953162 :9837AC4B:db_trace:kso.c@4103:ksonfy(): [10420:22:0] kso: new process: pso_index=22 reservation=251 time=447972829 2025-05-17 08:56:02.953162 :9837AC4C:db_trace:kso.c@4109:ksonfy(): [10420:22:0] kso: spawn diagnostics: queue time=0 secs 2025-05-17 08:56:02.953162 :9837AC4D:db_trace:kso.c@4111:ksonfy(): [10420:22:0] kso: spawn diagnostics: fork time=0 secs 2025-05-17 08:56:02.953163 :9837AC4E:db_trace:kso.c@4113:ksonfy(): [10420:22:0] kso: spawn diagnostics: exec time=0 secs 2025-05-17 08:56:02.953163 :9837AC4F:db_trace:kso.c@4115:ksonfy(): [10420:22:0] kso: spawn diagnostics: pre dbkc time=0 secs 2025-05-17 08:56:02.953163 :9837AC50:db_trace:kso.c@4117:ksonfy(): [10420:22:0] kso: spawn diagnostics: post dbkc time=0 secs 2025-05-17 08:56:02.953657 :9837AC51:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:22:177] KSL POST SENT postee=23 loc='kso2.h LINE:416 ID:ksoreq_reply' id1=0 id2=0 name= type=0 2025-05-17 08:56:02.953703 :9837AC58:db_trace:ksl2.c@12699:ksliwat(): [10005:22:177] KSL POST RCVD poster=23 loc='ksv2.h LINE:1639 ID:ksvpst: run' id1=0 id2=0 name= type=0 fac#=0 facpost=1 2025-05-17 09:06:03.751466 :98387F11:db_trace:kst.c@698:kstpsodel(): [10280:22:0] kst: process state object about to be deleted 2025-05-17 09:06:04.276442 :98387F8C:db_trace:kst.c@673:kstipg(): [10280:22:0] kst: process state object created on 05-17 09:06:04.271 2025-05-17 09:06:04.276444 :98387F8D:db_trace:kst.c@679:kstipg(): [10280:22:0] kst: process info: ospid=10976 pso_num=22 pso_serial#=89 2025-05-17 09:06:04.276578 :98387F8E:db_trace:kso.c@4093:ksonfy(): [10420:22:0] kso: new process: pid=10976 osp_idx=0 osp_ver=202304 osp_pg=0 (spawn #190708) 2025-05-17 09:06:04.276579 :98387F8F:db_trace:kso.c@4099:ksonfy(): [10420:22:0] kso: new process: first_req_pid=1236 spawner_pid=3660 sga_crt_ts=x8A8A 2025-05-17 09:06:04.276580 :98387F90:db_trace:kso.c@4103:ksonfy(): [10420:22:0] kso: new process: pso_index=22 reservation=252 time=448574141 2025-05-17 09:06:04.276580 :98387F91:db_trace:kso.c@4109:ksonfy(): [10420:22:0] kso: spawn diagnostics: queue time=0 secs 2025-05-17 09:06:04.276580 :98387F92:db_trace:kso.c@4111:ksonfy(): [10420:22:0] kso: spawn diagnostics: fork time=0 secs 2025-05-17 09:06:04.276581 :98387F93:db_trace:kso.c@4113:ksonfy(): [10420:22:0] kso: spawn diagnostics: exec time=0 secs 2025-05-17 09:06:04.276581 :98387F94:db_trace:kso.c@4115:ksonfy(): [10420:22:0] kso: spawn diagnostics: pre dbkc time=0 secs 2025-05-17 09:06:04.276581 :98387F95:db_trace:kso.c@4117:ksonfy(): [10420:22:0] kso: spawn diagnostics: post dbkc time=0 secs 2025-05-17 09:06:04.277123 :98387F96:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:22:177] KSL POST SENT postee=23 loc='kso2.h LINE:416 ID:ksoreq_reply' id1=0 id2=0 name= type=0 2025-05-17 09:06:04.277167 :98387F9E:db_trace:ksl2.c@12699:ksliwat(): [10005:22:177] KSL POST RCVD poster=23 loc='ksv2.h LINE:1639 ID:ksvpst: run' id1=0 id2=0 name= type=0 fac#=0 facpost=1 2025-05-17 09:15:19.304852 :98393600:db_trace:ksl2.c@12699:ksliwat(): [10005:22:177] KSL POST RCVD poster=16 loc='ksl2.h LINE:2165 ID:kslpsr' id1=255 id2=0 name=EV type=0 fac#=0 facpost=1 2025-05-17 09:16:05.759868 :98394569:db_trace:ksl2.c@12699:ksliwat(): [10005:22:177] KSL POST RCVD poster=23 loc='ksl2.h LINE:2165 ID:kslpsr' id1=255 id2=0 name=EV type=0 fac#=0 facpost=1 2025-05-17 09:26:06.653161 :983A0BB6:db_trace:kst.c@698:kstpsodel(): [10280:22:0] kst: process state object about to be deleted 2025-05-17 09:26:07.143215 :983A0BFB:db_trace:kst.c@673:kstipg(): [10280:22:0] kst: process state object created on 05-17 09:26:07.138 2025-05-17 09:26:07.143217 :983A0BFC:db_trace:kst.c@679:kstipg(): [10280:22:0] kst: process info: ospid=9376 pso_num=22 pso_serial#=90 2025-05-17 09:26:07.143359 :983A0BFD:db_trace:kso.c@4093:ksonfy(): [10420:22:0] kso: new process: pid=9376 osp_idx=0 osp_ver=202305 osp_pg=0 (spawn #190752) 2025-05-17 09:26:07.143359 :983A0BFE:db_trace:kso.c@4099:ksonfy(): [10420:22:0] kso: new process: first_req_pid=1236 spawner_pid=3660 sga_crt_ts=x8A8A 2025-05-17 09:26:07.143360 :983A0BFF:db_trace:kso.c@4103:ksonfy(): [10420:22:0] kso: new process: pso_index=22 reservation=253 time=449777016 2025-05-17 09:26:07.143360 :983A0C00:db_trace:kso.c@4109:ksonfy(): [10420:22:0] kso: spawn diagnostics: queue time=0 secs 2025-05-17 09:26:07.143361 :983A0C01:db_trace:kso.c@4111:ksonfy(): [10420:22:0] kso: spawn diagnostics: fork time=0 secs 2025-05-17 09:26:07.143361 :983A0C02:db_trace:kso.c@4113:ksonfy(): [10420:22:0] kso: spawn diagnostics: exec time=0 secs 2025-05-17 09:26:07.143361 :983A0C03:db_trace:kso.c@4115:ksonfy(): [10420:22:0] kso: spawn diagnostics: pre dbkc time=0 secs 2025-05-17 09:26:07.143361 :983A0C04:db_trace:kso.c@4117:ksonfy(): [10420:22:0] kso: spawn diagnostics: post dbkc time=0 secs 2025-05-17 09:26:07.143863 :983A0C05:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:22:177] KSL POST SENT postee=23 loc='kso2.h LINE:416 ID:ksoreq_reply' id1=0 id2=0 name= type=0 2025-05-17 09:26:07.143912 :983A0C0D:db_trace:ksl2.c@12699:ksliwat(): [10005:22:177] KSL POST RCVD poster=23 loc='ksv2.h LINE:1639 ID:ksvpst: run' id1=0 id2=0 name= type=0 fac#=0 facpost=1 2025-05-17 09:36:08.043209 :983AD273:db_trace:kst.c@698:kstpsodel(): [10280:22:0] kst: process state object about to be deleted 2025-05-17 09:36:08.610608 :983AD2CA:db_trace:kst.c@673:kstipg(): [10280:22:0] kst: process state object created on 05-17 09:36:08.606 2025-05-17 09:36:08.610610 :983AD2CB:db_trace:kst.c@679:kstipg(): [10280:22:0] kst: process info: ospid=12424 pso_num=22 pso_serial#=91 2025-05-17 09:36:08.610748 :983AD2CC:db_trace:kso.c@4093:ksonfy(): [10420:22:0] kso: new process: pid=12424 osp_idx=0 osp_ver=202306 osp_pg=0 (spawn #190775) 2025-05-17 09:36:08.610749 :983AD2CD:db_trace:kso.c@4099:ksonfy(): [10420:22:0] kso: new process: first_req_pid=1236 spawner_pid=3660 sga_crt_ts=x8A8A 2025-05-17 09:36:08.610749 :983AD2CE:db_trace:kso.c@4103:ksonfy(): [10420:22:0] kso: new process: pso_index=22 reservation=254 time=450378485 2025-05-17 09:36:08.610749 :983AD2CF:db_trace:kso.c@4109:ksonfy(): [10420:22:0] kso: spawn diagnostics: queue time=0 secs 2025-05-17 09:36:08.610750 :983AD2D0:db_trace:kso.c@4111:ksonfy(): [10420:22:0] kso: spawn diagnostics: fork time=0 secs 2025-05-17 09:36:08.610750 :983AD2D1:db_trace:kso.c@4113:ksonfy(): [10420:22:0] kso: spawn diagnostics: exec time=0 secs 2025-05-17 09:36:08.610750 :983AD2D2:db_trace:kso.c@4115:ksonfy(): [10420:22:0] kso: spawn diagnostics: pre dbkc time=0 secs 2025-05-17 09:36:08.610750 :983AD2D3:db_trace:kso.c@4117:ksonfy(): [10420:22:0] kso: spawn diagnostics: post dbkc time=0 secs 2025-05-17 09:36:08.611242 :983AD2D4:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:22:177] KSL POST SENT postee=23 loc='kso2.h LINE:416 ID:ksoreq_reply' id1=0 id2=0 name= type=0 2025-05-17 09:36:08.611286 :983AD2DC:db_trace:ksl2.c@12699:ksliwat(): [10005:22:177] KSL POST RCVD poster=23 loc='ksv2.h LINE:1639 ID:ksvpst: run' id1=0 id2=0 name= type=0 fac#=0 facpost=1 2025-05-17 09:46:09.498965 :983B9841:db_trace:kst.c@698:kstpsodel(): [10280:22:0] kst: process state object about to be deleted 2025-05-17 09:46:09.925553 :983B9886:db_trace:kst.c@673:kstipg(): [10280:22:0] kst: process state object created on 05-17 09:46:09.920 2025-05-17 09:46:09.925555 :983B9887:db_trace:kst.c@679:kstipg(): [10280:22:0] kst: process info: ospid=13252 pso_num=22 pso_serial#=92 2025-05-17 09:46:09.925690 :983B9888:db_trace:kso.c@4093:ksonfy(): [10420:22:0] kso: new process: pid=13252 osp_idx=0 osp_ver=202307 osp_pg=0 (spawn #190797) 2025-05-17 09:46:09.925690 :983B9889:db_trace:kso.c@4099:ksonfy(): [10420:22:0] kso: new process: first_req_pid=1236 spawner_pid=3660 sga_crt_ts=x8A8A 2025-05-17 09:46:09.925691 :983B988A:db_trace:kso.c@4103:ksonfy(): [10420:22:0] kso: new process: pso_index=22 reservation=255 time=450979797 2025-05-17 09:46:09.925691 :983B988B:db_trace:kso.c@4109:ksonfy(): [10420:22:0] kso: spawn diagnostics: queue time=0 secs 2025-05-17 09:46:09.925691 :983B988C:db_trace:kso.c@4111:ksonfy(): [10420:22:0] kso: spawn diagnostics: fork time=0 secs 2025-05-17 09:46:09.925692 :983B988D:db_trace:kso.c@4113:ksonfy(): [10420:22:0] kso: spawn diagnostics: exec time=0 secs 2025-05-17 09:46:09.925692 :983B988E:db_trace:kso.c@4115:ksonfy(): [10420:22:0] kso: spawn diagnostics: pre dbkc time=0 secs 2025-05-17 09:46:09.925692 :983B988F:db_trace:kso.c@4117:ksonfy(): [10420:22:0] kso: spawn diagnostics: post dbkc time=0 secs 2025-05-17 09:46:09.926172 :983B9890:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:22:177] KSL POST SENT postee=23 loc='kso2.h LINE:416 ID:ksoreq_reply' id1=0 id2=0 name= type=0 2025-05-17 09:46:09.926220 :983B9898:db_trace:ksl2.c@12699:ksliwat(): [10005:22:177] KSL POST RCVD poster=23 loc='ksv2.h LINE:1639 ID:ksvpst: run' id1=0 id2=0 name= type=0 fac#=0 facpost=1 2025-05-17 09:56:10.894567 :983C5F1D:db_trace:kst.c@698:kstpsodel(): [10280:22:0] kst: process state object about to be deleted 2025-05-17 09:56:11.367991 :983C5F6D:db_trace:kst.c@673:kstipg(): [10280:22:0] kst: process state object created on 05-17 09:56:11.363 2025-05-17 09:56:11.367993 :983C5F6E:db_trace:kst.c@679:kstipg(): [10280:22:0] kst: process info: ospid=13832 pso_num=22 pso_serial#=93 2025-05-17 09:56:11.368139 :983C5F6F:db_trace:kso.c@4093:ksonfy(): [10420:22:0] kso: new process: pid=13832 osp_idx=0 osp_ver=202308 osp_pg=0 (spawn #190820) 2025-05-17 09:56:11.368140 :983C5F70:db_trace:kso.c@4099:ksonfy(): [10420:22:0] kso: new process: first_req_pid=1236 spawner_pid=3660 sga_crt_ts=x8A8A 2025-05-17 09:56:11.368140 :983C5F71:db_trace:kso.c@4103:ksonfy(): [10420:22:0] kso: new process: pso_index=22 reservation=0 time=451581235 2025-05-17 09:56:11.368141 :983C5F72:db_trace:kso.c@4109:ksonfy(): [10420:22:0] kso: spawn diagnostics: queue time=0 secs 2025-05-17 09:56:11.368141 :983C5F73:db_trace:kso.c@4111:ksonfy(): [10420:22:0] kso: spawn diagnostics: fork time=0 secs 2025-05-17 09:56:11.368141 :983C5F74:db_trace:kso.c@4113:ksonfy(): [10420:22:0] kso: spawn diagnostics: exec time=0 secs 2025-05-17 09:56:11.368142 :983C5F75:db_trace:kso.c@4115:ksonfy(): [10420:22:0] kso: spawn diagnostics: pre dbkc time=0 secs 2025-05-17 09:56:11.368142 :983C5F76:db_trace:kso.c@4117:ksonfy(): [10420:22:0] kso: spawn diagnostics: post dbkc time=0 secs 2025-05-17 09:56:11.368641 :983C5F77:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:22:177] KSL POST SENT postee=23 loc='kso2.h LINE:416 ID:ksoreq_reply' id1=0 id2=0 name= type=0 2025-05-17 09:56:11.368690 :983C5F80:db_trace:ksl2.c@12699:ksliwat(): [10005:22:177] KSL POST RCVD poster=23 loc='ksv2.h LINE:1639 ID:ksvpst: run' id1=0 id2=0 name= type=0 fac#=0 facpost=1 2025-05-17 10:06:12.284742 :983D2E16:db_trace:kst.c@698:kstpsodel(): [10280:22:0] kst: process state object about to be deleted 2025-05-17 10:06:12.709594 :983D2E24:db_trace:kst.c@673:kstipg(): [10280:22:0] kst: process state object created on 05-17 10:06:12.706 2025-05-17 10:06:12.709596 :983D2E25:db_trace:kst.c@679:kstipg(): [10280:22:0] kst: process info: ospid=5912 pso_num=22 pso_serial#=94 2025-05-17 10:06:12.709737 :983D2E26:db_trace:kso.c@4070:ksonfy(): [10420:22:0] kso: new process: pid=5912 (legacy spawn) 2025-05-17 10:06:12.716101 :983D2E27:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:22:177] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-05-17 10:06:12.716294 :983D2E2C:db_trace:ksl2.c@12699:ksliwat(): [10005:22:177] KSL POST RCVD poster=14 loc='ksl2.h LINE:2165 ID:kslpsr' id1=134 id2=0 name=EV type=0 fac#=0 facpost=1 2025-05-17 10:06:12.717085 :983D2E31:db_trace:kst.c@698:kstpsodel(): [10280:22:0] kst: process state object about to be deleted 2025-05-17 10:06:12.746439 :983D2E34:db_trace:kst.c@673:kstipg(): [10280:22:0] kst: process state object created on 05-17 10:06:12.738 2025-05-17 10:06:12.746440 :983D2E35:db_trace:kst.c@679:kstipg(): [10280:22:0] kst: process info: ospid=13760 pso_num=22 pso_serial#=95 2025-05-17 10:06:12.746580 :983D2E36:db_trace:kso.c@4070:ksonfy(): [10420:22:0] kso: new process: pid=13760 (legacy spawn) 2025-05-17 10:06:12.752970 :983D2E37:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:22:177] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-05-17 10:06:12.753159 :983D2E40:db_trace:ksl2.c@12699:ksliwat(): [10005:22:177] KSL POST RCVD poster=14 loc='ksl2.h LINE:2165 ID:kslpsr' id1=134 id2=0 name=EV type=0 fac#=0 facpost=1 2025-05-17 10:06:12.753932 :983D2E41:db_trace:kst.c@698:kstpsodel(): [10280:22:0] kst: process state object about to be deleted 2025-05-17 10:06:12.789446 :983D2E7F:db_trace:kst.c@673:kstipg(): [10280:22:0] kst: process state object created on 05-17 10:06:12.784 2025-05-17 10:06:12.789448 :983D2E80:db_trace:kst.c@679:kstipg(): [10280:22:0] kst: process info: ospid=12848 pso_num=22 pso_serial#=96 2025-05-17 10:06:12.789592 :983D2E81:db_trace:kso.c@4093:ksonfy(): [10420:22:0] kso: new process: pid=12848 osp_idx=0 osp_ver=202311 osp_pg=0 (spawn #190846) 2025-05-17 10:06:12.789593 :983D2E82:db_trace:kso.c@4099:ksonfy(): [10420:22:0] kso: new process: first_req_pid=1236 spawner_pid=3660 sga_crt_ts=x8A8A 2025-05-17 10:06:12.789594 :983D2E83:db_trace:kso.c@4103:ksonfy(): [10420:22:0] kso: new process: pso_index=22 reservation=1 time=452182657 2025-05-17 10:06:12.789594 :983D2E84:db_trace:kso.c@4109:ksonfy(): [10420:22:0] kso: spawn diagnostics: queue time=0 secs 2025-05-17 10:06:12.789594 :983D2E85:db_trace:kso.c@4111:ksonfy(): [10420:22:0] kso: spawn diagnostics: fork time=0 secs 2025-05-17 10:06:12.789595 :983D2E86:db_trace:kso.c@4113:ksonfy(): [10420:22:0] kso: spawn diagnostics: exec time=0 secs 2025-05-17 10:06:12.789595 :983D2E87:db_trace:kso.c@4115:ksonfy(): [10420:22:0] kso: spawn diagnostics: pre dbkc time=0 secs 2025-05-17 10:06:12.789595 :983D2E88:db_trace:kso.c@4117:ksonfy(): [10420:22:0] kso: spawn diagnostics: post dbkc time=0 secs 2025-05-17 10:06:12.790089 :983D2E89:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:22:177] KSL POST SENT postee=23 loc='kso2.h LINE:416 ID:ksoreq_reply' id1=0 id2=0 name= type=0 2025-05-17 10:06:12.790133 :983D2E91:db_trace:ksl2.c@12699:ksliwat(): [10005:22:177] KSL POST RCVD poster=23 loc='ksv2.h LINE:1639 ID:ksvpst: run' id1=0 id2=0 name= type=0 fac#=0 facpost=1 ------------------------------------------------------------------------------- Trace Bucket Dump End: default bucket for process 22 (osid: 12848, W000)
Ms-Dos/Windows
Unix
Write backup
jsp File Browser version 1.2 by
www.vonloesch.de