Edit D:\app\Administrator\diag\rdbms\orcl\orcl\trace\cdmp_20250831100608\orcl_w000_23144_bucket.trc
Trace file d:\app\administrator\diag\rdbms\orcl\orcl\trace\cdmp_20250831100608\orcl_w000_23144_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:35088M/63366M, Ph+PgF:40082M/72582M Instance name: orcl Redo thread mounted by this instance: 1 Oracle process number: 22 Windows thread id: 23144, image: ORACLE.EXE (W000) *** 2025-08-31 10:06:08.084 *** SESSION ID:(177.13427) 2025-08-31 10:06:08.084 *** 2025-08-31 10:06:08.084 Process diagnostic dump for ORACLE.EXE (W000), OS id=23144, pid: 22, proc_ser: 225, sid: 177, sess_ser: 13427 ------------------------------------------------------------------------------- current sql: <none> Current Wait Stack: 0: waiting for 'Space Manager: slave idle wait' Slave ID=0x0, =0x0, =0x0 wait_id=89 seq_num=90 snap_id=1 wait times: snap=3.930704 sec, exc=3.930704 sec, total=3.930704 sec wait times: max=5.000000 sec, heur=7 min 24 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.000035 sec since current wait 0: waited for 'Space Manager: slave idle wait' Slave ID=0x0, =0x0, =0x0 wait_id=88 seq_num=89 snap_id=1 wait times: snap=5.000278 sec, exc=5.000278 sec, total=5.000278 sec wait times: max=5.000000 sec wait counts: calls=1 os=1 occurred after 0.000035 sec of elapsed time 1: waited for 'Space Manager: slave idle wait' Slave ID=0x0, =0x0, =0x0 wait_id=87 seq_num=88 snap_id=1 wait times: snap=5.014665 sec, exc=5.014665 sec, total=5.014665 sec wait times: max=5.000000 sec wait counts: calls=1 os=1 occurred after 0.000031 sec of elapsed time 2: waited for 'Space Manager: slave idle wait' Slave ID=0x0, =0x0, =0x0 wait_id=86 seq_num=87 snap_id=1 wait times: snap=5.012448 sec, exc=5.012448 sec, total=5.012448 sec wait times: max=5.000000 sec wait counts: calls=1 os=1 occurred after 0.000033 sec of elapsed time 3: waited for 'Space Manager: slave idle wait' Slave ID=0x0, =0x0, =0x0 wait_id=85 seq_num=86 snap_id=1 wait times: snap=5.009223 sec, exc=5.009223 sec, total=5.009223 sec wait times: max=5.000000 sec wait counts: calls=1 os=1 occurred after 0.000031 sec of elapsed time 4: waited for 'Space Manager: slave idle wait' Slave ID=0x0, =0x0, =0x0 wait_id=84 seq_num=85 snap_id=1 wait times: snap=5.010147 sec, exc=5.010147 sec, total=5.010147 sec wait times: max=5.000000 sec wait counts: calls=1 os=1 occurred after 0.000032 sec of elapsed time 5: waited for 'Space Manager: slave idle wait' Slave ID=0x0, =0x0, =0x0 wait_id=83 seq_num=84 snap_id=1 wait times: snap=5.014658 sec, exc=5.014658 sec, total=5.014658 sec wait times: max=5.000000 sec wait counts: calls=1 os=1 occurred after 0.000103 sec of elapsed time 6: waited for 'Space Manager: slave idle wait' Slave ID=0x0, =0x0, =0x0 wait_id=82 seq_num=83 snap_id=1 wait times: snap=5.004621 sec, exc=5.004621 sec, total=5.004621 sec wait times: max=5.000000 sec wait counts: calls=1 os=1 occurred after 0.000037 sec of elapsed time 7: waited for 'Space Manager: slave idle wait' Slave ID=0x0, =0x0, =0x0 wait_id=81 seq_num=82 snap_id=1 wait times: snap=5.008368 sec, exc=5.008368 sec, total=5.008368 sec wait times: max=5.000000 sec wait counts: calls=1 os=1 occurred after 0.000028 sec of elapsed time 8: waited for 'Space Manager: slave idle wait' Slave ID=0x0, =0x0, =0x0 wait_id=80 seq_num=81 snap_id=1 wait times: snap=5.003104 sec, exc=5.003104 sec, total=5.003104 sec wait times: max=5.000000 sec wait counts: calls=1 os=1 occurred after 0.000030 sec of elapsed time 9: waited for 'Space Manager: slave idle wait' Slave ID=0x0, =0x0, =0x0 wait_id=79 seq_num=80 snap_id=1 wait times: snap=5.003550 sec, exc=5.003550 sec, total=5.003550 sec wait times: max=5.000000 sec wait counts: calls=1 os=1 occurred after 0.000036 sec of elapsed time Sampled Session History of session 177 serial 13427 --------------------------------------------------- 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 --------------------------------------------------- [121 samples, 10:04:08 - 10:06:08] idle wait at each sample ------------------------------------------------------------------------------- Process diagnostic dump actual duration=0.000000 sec (max dump time=30.000000 sec) *** 2025-08-31 10:06:08.084 ------------------------------------------------------------------------------- Trace Bucket Dump Begin: default bucket for process 22 (osid: 23144, W000) TIME(*=approx):SEQ:COMPONENT:FILE@LINE:FUNCTION:SECT/DUMP: [EVENT#:PID:SID] DATA ------------------------------------------------------------------------------- 2025-08-31 07:38:27.038725 :C6FF9E48:db_trace:kst.c@679:kstipg(): [10280:22:0] kst: process info: ospid=23216 pso_num=22 pso_serial#=212 2025-08-31 07:38:27.038870 :C6FF9E49:db_trace:kso.c@4093:ksonfy(): [10420:22:0] kso: new process: pid=23216 osp_idx=0 osp_ver=557969 osp_pg=0 (spawn #543833) 2025-08-31 07:38:27.038870 :C6FF9E4A:db_trace:kso.c@4099:ksonfy(): [10420:22:0] kso: new process: first_req_pid=1236 spawner_pid=3660 sga_crt_ts=x8A8A 2025-08-31 07:38:27.038871 :C6FF9E4B:db_trace:kso.c@4103:ksonfy(): [10420:22:0] kso: new process: pso_index=22 reservation=248 time=1011558346 2025-08-31 07:38:27.038871 :C6FF9E4C:db_trace:kso.c@4109:ksonfy(): [10420:22:0] kso: spawn diagnostics: queue time=0 secs 2025-08-31 07:38:27.038872 :C6FF9E4D:db_trace:kso.c@4111:ksonfy(): [10420:22:0] kso: spawn diagnostics: fork time=0 secs 2025-08-31 07:38:27.038872 :C6FF9E4E:db_trace:kso.c@4113:ksonfy(): [10420:22:0] kso: spawn diagnostics: exec time=0 secs 2025-08-31 07:38:27.038872 :C6FF9E4F:db_trace:kso.c@4115:ksonfy(): [10420:22:0] kso: spawn diagnostics: pre dbkc time=0 secs 2025-08-31 07:38:27.038873 :C6FF9E50:db_trace:kso.c@4117:ksonfy(): [10420:22:0] kso: spawn diagnostics: post dbkc time=0 secs 2025-08-31 07:38:27.039387 :C6FF9E51: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-08-31 07:38:27.039446 :C6FF9E5A: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-08-31 07:48:27.871983 :C70064E2:db_trace:kst.c@698:kstpsodel(): [10280:22:0] kst: process state object about to be deleted 2025-08-31 07:48:28.173823 :C7006526:db_trace:kst.c@673:kstipg(): [10280:22:0] kst: process state object created on 08-31 07:48:28.168 2025-08-31 07:48:28.173825 :C7006527:db_trace:kst.c@679:kstipg(): [10280:22:0] kst: process info: ospid=6008 pso_num=22 pso_serial#=213 2025-08-31 07:48:28.173970 :C7006528:db_trace:kso.c@4093:ksonfy(): [10420:22:0] kso: new process: pid=6008 osp_idx=0 osp_ver=557970 osp_pg=0 (spawn #543856) 2025-08-31 07:48:28.173971 :C7006529:db_trace:kso.c@4099:ksonfy(): [10420:22:0] kso: new process: first_req_pid=1236 spawner_pid=3660 sga_crt_ts=x8A8A 2025-08-31 07:48:28.173971 :C700652A:db_trace:kso.c@4103:ksonfy(): [10420:22:0] kso: new process: pso_index=22 reservation=249 time=1012159471 2025-08-31 07:48:28.173971 :C700652B:db_trace:kso.c@4109:ksonfy(): [10420:22:0] kso: spawn diagnostics: queue time=0 secs 2025-08-31 07:48:28.173971 :C700652C:db_trace:kso.c@4111:ksonfy(): [10420:22:0] kso: spawn diagnostics: fork time=0 secs 2025-08-31 07:48:28.173972 :C700652D:db_trace:kso.c@4113:ksonfy(): [10420:22:0] kso: spawn diagnostics: exec time=0 secs 2025-08-31 07:48:28.173972 :C700652E:db_trace:kso.c@4115:ksonfy(): [10420:22:0] kso: spawn diagnostics: pre dbkc time=0 secs 2025-08-31 07:48:28.173972 :C700652F:db_trace:kso.c@4117:ksonfy(): [10420:22:0] kso: spawn diagnostics: post dbkc time=0 secs 2025-08-31 07:48:28.174470 :C7006530: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-08-31 07:48:28.174514 :C7006536: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-08-31 07:58:29.045318 :C7012B6C:db_trace:kst.c@698:kstpsodel(): [10280:22:0] kst: process state object about to be deleted 2025-08-31 07:58:29.393758 :C7012BB9:db_trace:kst.c@673:kstipg(): [10280:22:0] kst: process state object created on 08-31 07:58:29.389 2025-08-31 07:58:29.393760 :C7012BBA:db_trace:kst.c@679:kstipg(): [10280:22:0] kst: process info: ospid=20840 pso_num=22 pso_serial#=214 2025-08-31 07:58:29.393903 :C7012BBB:db_trace:kso.c@4093:ksonfy(): [10420:22:0] kso: new process: pid=20840 osp_idx=0 osp_ver=557971 osp_pg=0 (spawn #543878) 2025-08-31 07:58:29.393904 :C7012BBC:db_trace:kso.c@4099:ksonfy(): [10420:22:0] kso: new process: first_req_pid=1236 spawner_pid=3660 sga_crt_ts=x8A8A 2025-08-31 07:58:29.393904 :C7012BBD:db_trace:kso.c@4103:ksonfy(): [10420:22:0] kso: new process: pso_index=22 reservation=250 time=1012760705 2025-08-31 07:58:29.393904 :C7012BBE:db_trace:kso.c@4109:ksonfy(): [10420:22:0] kso: spawn diagnostics: queue time=0 secs 2025-08-31 07:58:29.393905 :C7012BBF:db_trace:kso.c@4111:ksonfy(): [10420:22:0] kso: spawn diagnostics: fork time=0 secs 2025-08-31 07:58:29.393905 :C7012BC0:db_trace:kso.c@4113:ksonfy(): [10420:22:0] kso: spawn diagnostics: exec time=0 secs 2025-08-31 07:58:29.393905 :C7012BC1:db_trace:kso.c@4115:ksonfy(): [10420:22:0] kso: spawn diagnostics: pre dbkc time=0 secs 2025-08-31 07:58:29.393906 :C7012BC2:db_trace:kso.c@4117:ksonfy(): [10420:22:0] kso: spawn diagnostics: post dbkc time=0 secs 2025-08-31 07:58:29.394434 :C7012BC3: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-08-31 07:58:29.394482 :C7012BCC: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-08-31 07:59:44.529722 :C7014455:db_trace:ksl2.c@2477:kslwtbctx(): [10005:22:177] KSL WAIT BEG [latch free] 136537728/0x8236680 259/0x103 0/0x0 wait_id=16 seq_num=17 snap_id=1 2025-08-31 07:59:44.529727 :C7014457:db_trace:ksl2.c@2611:kslwtectx(): [10005:22:177] KSL WAIT END [latch free] 136537728/0x8236680 259/0x103 0/0x0 wait_id=16 seq_num=17 snap_id=1 2025-08-31 07:59:44.529728 :C7014459:db_trace:ksl2.c@2619:kslwtectx(): [10005:22:177] KSL WAIT END wait times (usecs) - snap=6, exc=6, tot=6 2025-08-31 07:59:44.529737 :C7014465: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-08-31 08:08:30.187327 :C701FCED:db_trace:kst.c@698:kstpsodel(): [10280:22:0] kst: process state object about to be deleted 2025-08-31 08:08:30.535806 :C701FD29:db_trace:kst.c@673:kstipg(): [10280:22:0] kst: process state object created on 08-31 08:08:30.531 2025-08-31 08:08:30.535808 :C701FD2A:db_trace:kst.c@679:kstipg(): [10280:22:0] kst: process info: ospid=7196 pso_num=22 pso_serial#=215 2025-08-31 08:08:30.535943 :C701FD2B:db_trace:kso.c@4093:ksonfy(): [10420:22:0] kso: new process: pid=7196 osp_idx=0 osp_ver=557972 osp_pg=0 (spawn #543904) 2025-08-31 08:08:30.535944 :C701FD2C:db_trace:kso.c@4099:ksonfy(): [10420:22:0] kso: new process: first_req_pid=1236 spawner_pid=3660 sga_crt_ts=x8A8A 2025-08-31 08:08:30.535945 :C701FD2D:db_trace:kso.c@4103:ksonfy(): [10420:22:0] kso: new process: pso_index=22 reservation=251 time=1013361846 2025-08-31 08:08:30.535945 :C701FD2E:db_trace:kso.c@4109:ksonfy(): [10420:22:0] kso: spawn diagnostics: queue time=0 secs 2025-08-31 08:08:30.535946 :C701FD2F:db_trace:kso.c@4111:ksonfy(): [10420:22:0] kso: spawn diagnostics: fork time=0 secs 2025-08-31 08:08:30.535946 :C701FD30:db_trace:kso.c@4113:ksonfy(): [10420:22:0] kso: spawn diagnostics: exec time=0 secs 2025-08-31 08:08:30.535946 :C701FD31:db_trace:kso.c@4115:ksonfy(): [10420:22:0] kso: spawn diagnostics: pre dbkc time=0 secs 2025-08-31 08:08:30.535946 :C701FD32:db_trace:kso.c@4117:ksonfy(): [10420:22:0] kso: spawn diagnostics: post dbkc time=0 secs 2025-08-31 08:08:30.536427 :C701FD33: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-08-31 08:08:30.536474 :C701FD3B: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-08-31 08:18:31.413101 :C70311F4:db_trace:kst.c@698:kstpsodel(): [10280:22:0] kst: process state object about to be deleted 2025-08-31 08:18:31.699157 :C7031239:db_trace:kst.c@673:kstipg(): [10280:22:0] kst: process state object created on 08-31 08:18:31.694 2025-08-31 08:18:31.699158 :C703123A:db_trace:kst.c@679:kstipg(): [10280:22:0] kst: process info: ospid=20516 pso_num=22 pso_serial#=216 2025-08-31 08:18:31.699299 :C703123B:db_trace:kso.c@4093:ksonfy(): [10420:22:0] kso: new process: pid=20516 osp_idx=0 osp_ver=557973 osp_pg=0 (spawn #543932) 2025-08-31 08:18:31.699299 :C703123C:db_trace:kso.c@4099:ksonfy(): [10420:22:0] kso: new process: first_req_pid=1236 spawner_pid=3660 sga_crt_ts=x8A8A 2025-08-31 08:18:31.699300 :C703123D:db_trace:kso.c@4103:ksonfy(): [10420:22:0] kso: new process: pso_index=22 reservation=252 time=1013963002 2025-08-31 08:18:31.699300 :C703123E:db_trace:kso.c@4109:ksonfy(): [10420:22:0] kso: spawn diagnostics: queue time=0 secs 2025-08-31 08:18:31.699301 :C703123F:db_trace:kso.c@4111:ksonfy(): [10420:22:0] kso: spawn diagnostics: fork time=0 secs 2025-08-31 08:18:31.699301 :C7031240:db_trace:kso.c@4113:ksonfy(): [10420:22:0] kso: spawn diagnostics: exec time=0 secs 2025-08-31 08:18:31.699301 :C7031241:db_trace:kso.c@4115:ksonfy(): [10420:22:0] kso: spawn diagnostics: pre dbkc time=0 secs 2025-08-31 08:18:31.699302 :C7031242:db_trace:kso.c@4117:ksonfy(): [10420:22:0] kso: spawn diagnostics: post dbkc time=0 secs 2025-08-31 08:18:31.699796 :C7031243: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-08-31 08:18:31.699840 :C703124B: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-08-31 08:28:32.475959 :C703FA31:db_trace:kst.c@698:kstpsodel(): [10280:22:0] kst: process state object about to be deleted 2025-08-31 08:28:32.881462 :C703FA6B:db_trace:kst.c@673:kstipg(): [10280:22:0] kst: process state object created on 08-31 08:28:32.876 2025-08-31 08:28:32.881464 :C703FA6C:db_trace:kst.c@679:kstipg(): [10280:22:0] kst: process info: ospid=21936 pso_num=22 pso_serial#=217 2025-08-31 08:28:32.881600 :C703FA6D:db_trace:kso.c@4093:ksonfy(): [10420:22:0] kso: new process: pid=21936 osp_idx=0 osp_ver=557974 osp_pg=0 (spawn #543954) 2025-08-31 08:28:32.881601 :C703FA6E:db_trace:kso.c@4099:ksonfy(): [10420:22:0] kso: new process: first_req_pid=1236 spawner_pid=3660 sga_crt_ts=x8A8A 2025-08-31 08:28:32.881601 :C703FA6F:db_trace:kso.c@4103:ksonfy(): [10420:22:0] kso: new process: pso_index=22 reservation=253 time=1014564190 2025-08-31 08:28:32.881602 :C703FA70:db_trace:kso.c@4109:ksonfy(): [10420:22:0] kso: spawn diagnostics: queue time=0 secs 2025-08-31 08:28:32.881602 :C703FA71:db_trace:kso.c@4111:ksonfy(): [10420:22:0] kso: spawn diagnostics: fork time=0 secs 2025-08-31 08:28:32.881602 :C703FA72:db_trace:kso.c@4113:ksonfy(): [10420:22:0] kso: spawn diagnostics: exec time=0 secs 2025-08-31 08:28:32.881603 :C703FA73:db_trace:kso.c@4115:ksonfy(): [10420:22:0] kso: spawn diagnostics: pre dbkc time=0 secs 2025-08-31 08:28:32.881603 :C703FA74:db_trace:kso.c@4117:ksonfy(): [10420:22:0] kso: spawn diagnostics: post dbkc time=0 secs 2025-08-31 08:28:32.882098 :C703FA75: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-08-31 08:28:32.882144 :C703FA7D: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-08-31 08:38:33.913607 :C704C37C:db_trace:kst.c@698:kstpsodel(): [10280:22:0] kst: process state object about to be deleted 2025-08-31 08:38:34.153741 :C704C3C3:db_trace:kst.c@673:kstipg(): [10280:22:0] kst: process state object created on 08-31 08:38:34.148 2025-08-31 08:38:34.153743 :C704C3C4:db_trace:kst.c@679:kstipg(): [10280:22:0] kst: process info: ospid=16392 pso_num=22 pso_serial#=218 2025-08-31 08:38:34.153891 :C704C3C5:db_trace:kso.c@4093:ksonfy(): [10420:22:0] kso: new process: pid=16392 osp_idx=0 osp_ver=557975 osp_pg=0 (spawn #543977) 2025-08-31 08:38:34.153892 :C704C3C6:db_trace:kso.c@4099:ksonfy(): [10420:22:0] kso: new process: first_req_pid=1236 spawner_pid=3660 sga_crt_ts=x8A8A 2025-08-31 08:38:34.153893 :C704C3C7:db_trace:kso.c@4103:ksonfy(): [10420:22:0] kso: new process: pso_index=22 reservation=254 time=1015165455 2025-08-31 08:38:34.153894 :C704C3C8:db_trace:kso.c@4109:ksonfy(): [10420:22:0] kso: spawn diagnostics: queue time=0 secs 2025-08-31 08:38:34.153894 :C704C3C9:db_trace:kso.c@4111:ksonfy(): [10420:22:0] kso: spawn diagnostics: fork time=0 secs 2025-08-31 08:38:34.153895 :C704C3CA:db_trace:kso.c@4113:ksonfy(): [10420:22:0] kso: spawn diagnostics: exec time=0 secs 2025-08-31 08:38:34.153895 :C704C3CB:db_trace:kso.c@4115:ksonfy(): [10420:22:0] kso: spawn diagnostics: pre dbkc time=0 secs 2025-08-31 08:38:34.153896 :C704C3CC:db_trace:kso.c@4117:ksonfy(): [10420:22:0] kso: spawn diagnostics: post dbkc time=0 secs 2025-08-31 08:38:34.154483 :C704C3CD: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-08-31 08:38:34.154550 :C704C3D7: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-08-31 08:48:34.956015 :C7058CDE:db_trace:kst.c@698:kstpsodel(): [10280:22:0] kst: process state object about to be deleted 2025-08-31 08:48:35.367057 :C7058D1B:db_trace:kst.c@673:kstipg(): [10280:22:0] kst: process state object created on 08-31 08:48:35.362 2025-08-31 08:48:35.367059 :C7058D1C:db_trace:kst.c@679:kstipg(): [10280:22:0] kst: process info: ospid=22188 pso_num=22 pso_serial#=219 2025-08-31 08:48:35.367205 :C7058D1D:db_trace:kso.c@4093:ksonfy(): [10420:22:0] kso: new process: pid=22188 osp_idx=0 osp_ver=557976 osp_pg=0 (spawn #544001) 2025-08-31 08:48:35.367205 :C7058D1E:db_trace:kso.c@4099:ksonfy(): [10420:22:0] kso: new process: first_req_pid=1236 spawner_pid=3660 sga_crt_ts=x8A8A 2025-08-31 08:48:35.367206 :C7058D1F:db_trace:kso.c@4103:ksonfy(): [10420:22:0] kso: new process: pso_index=22 reservation=255 time=1015766674 2025-08-31 08:48:35.367207 :C7058D20:db_trace:kso.c@4109:ksonfy(): [10420:22:0] kso: spawn diagnostics: queue time=0 secs 2025-08-31 08:48:35.367207 :C7058D21:db_trace:kso.c@4111:ksonfy(): [10420:22:0] kso: spawn diagnostics: fork time=0 secs 2025-08-31 08:48:35.367207 :C7058D22:db_trace:kso.c@4113:ksonfy(): [10420:22:0] kso: spawn diagnostics: exec time=0 secs 2025-08-31 08:48:35.367208 :C7058D23:db_trace:kso.c@4115:ksonfy(): [10420:22:0] kso: spawn diagnostics: pre dbkc time=0 secs 2025-08-31 08:48:35.367208 :C7058D24:db_trace:kso.c@4117:ksonfy(): [10420:22:0] kso: spawn diagnostics: post dbkc time=0 secs 2025-08-31 08:48:35.367708 :C7058D25: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-08-31 08:48:35.367753 :C7058D2C: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-08-31 08:58:36.203907 :C70654C0:db_trace:kst.c@698:kstpsodel(): [10280:22:0] kst: process state object about to be deleted 2025-08-31 08:58:36.521229 :C70654F9:db_trace:kst.c@673:kstipg(): [10280:22:0] kst: process state object created on 08-31 08:58:36.517 2025-08-31 08:58:36.521231 :C70654FA:db_trace:kst.c@679:kstipg(): [10280:22:0] kst: process info: ospid=21740 pso_num=22 pso_serial#=220 2025-08-31 08:58:36.521373 :C70654FB:db_trace:kso.c@4093:ksonfy(): [10420:22:0] kso: new process: pid=21740 osp_idx=0 osp_ver=557977 osp_pg=0 (spawn #544023) 2025-08-31 08:58:36.521374 :C70654FC:db_trace:kso.c@4099:ksonfy(): [10420:22:0] kso: new process: first_req_pid=1236 spawner_pid=3660 sga_crt_ts=x8A8A 2025-08-31 08:58:36.521374 :C70654FD:db_trace:kso.c@4103:ksonfy(): [10420:22:0] kso: new process: pso_index=22 reservation=0 time=1016367830 2025-08-31 08:58:36.521375 :C70654FE:db_trace:kso.c@4109:ksonfy(): [10420:22:0] kso: spawn diagnostics: queue time=0 secs 2025-08-31 08:58:36.521375 :C70654FF:db_trace:kso.c@4111:ksonfy(): [10420:22:0] kso: spawn diagnostics: fork time=0 secs 2025-08-31 08:58:36.521375 :C7065500:db_trace:kso.c@4113:ksonfy(): [10420:22:0] kso: spawn diagnostics: exec time=0 secs 2025-08-31 08:58:36.521376 :C7065501:db_trace:kso.c@4115:ksonfy(): [10420:22:0] kso: spawn diagnostics: pre dbkc time=0 secs 2025-08-31 08:58:36.521376 :C7065502:db_trace:kso.c@4117:ksonfy(): [10420:22:0] kso: spawn diagnostics: post dbkc time=0 secs 2025-08-31 08:58:36.521877 :C7065503: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-08-31 08:58:36.521924 :C706550B: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-08-31 09:08:37.234444 :C7072F3A:db_trace:kst.c@698:kstpsodel(): [10280:22:0] kst: process state object about to be deleted 2025-08-31 09:08:37.614185 :C7072F72:db_trace:kst.c@673:kstipg(): [10280:22:0] kst: process state object created on 08-31 09:08:37.609 2025-08-31 09:08:37.614187 :C7072F73:db_trace:kst.c@679:kstipg(): [10280:22:0] kst: process info: ospid=22276 pso_num=22 pso_serial#=221 2025-08-31 09:08:37.614319 :C7072F74:db_trace:kso.c@4093:ksonfy(): [10420:22:0] kso: new process: pid=22276 osp_idx=0 osp_ver=557978 osp_pg=0 (spawn #544049) 2025-08-31 09:08:37.614320 :C7072F75:db_trace:kso.c@4099:ksonfy(): [10420:22:0] kso: new process: first_req_pid=1236 spawner_pid=3660 sga_crt_ts=x8A8A 2025-08-31 09:08:37.614320 :C7072F76:db_trace:kso.c@4103:ksonfy(): [10420:22:0] kso: new process: pso_index=22 reservation=1 time=1016968924 2025-08-31 09:08:37.614321 :C7072F77:db_trace:kso.c@4109:ksonfy(): [10420:22:0] kso: spawn diagnostics: queue time=0 secs 2025-08-31 09:08:37.614321 :C7072F78:db_trace:kso.c@4111:ksonfy(): [10420:22:0] kso: spawn diagnostics: fork time=0 secs 2025-08-31 09:08:37.614321 :C7072F79:db_trace:kso.c@4113:ksonfy(): [10420:22:0] kso: spawn diagnostics: exec time=0 secs 2025-08-31 09:08:37.614321 :C7072F7A:db_trace:kso.c@4115:ksonfy(): [10420:22:0] kso: spawn diagnostics: pre dbkc time=0 secs 2025-08-31 09:08:37.614322 :C7072F7B:db_trace:kso.c@4117:ksonfy(): [10420:22:0] kso: spawn diagnostics: post dbkc time=0 secs 2025-08-31 09:08:37.614820 :C7072F7C: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-08-31 09:08:37.614864 :C7072F83: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-08-31 09:18:38.461785 :C707FB80:db_trace:kst.c@698:kstpsodel(): [10280:22:0] kst: process state object about to be deleted 2025-08-31 09:18:38.716432 :C707FBF0:db_trace:kst.c@673:kstipg(): [10280:22:0] kst: process state object created on 08-31 09:18:38.712 2025-08-31 09:18:38.716433 :C707FBF1:db_trace:kst.c@679:kstipg(): [10280:22:0] kst: process info: ospid=23416 pso_num=22 pso_serial#=222 2025-08-31 09:18:38.716573 :C707FBF2:db_trace:kso.c@4093:ksonfy(): [10420:22:0] kso: new process: pid=23416 osp_idx=0 osp_ver=557979 osp_pg=0 (spawn #544072) 2025-08-31 09:18:38.716574 :C707FBF3:db_trace:kso.c@4099:ksonfy(): [10420:22:0] kso: new process: first_req_pid=1236 spawner_pid=3660 sga_crt_ts=x8A8A 2025-08-31 09:18:38.716575 :C707FBF4:db_trace:kso.c@4103:ksonfy(): [10420:22:0] kso: new process: pso_index=22 reservation=2 time=1017570018 2025-08-31 09:18:38.716575 :C707FBF5:db_trace:kso.c@4109:ksonfy(): [10420:22:0] kso: spawn diagnostics: queue time=0 secs 2025-08-31 09:18:38.716576 :C707FBF6:db_trace:kso.c@4111:ksonfy(): [10420:22:0] kso: spawn diagnostics: fork time=0 secs 2025-08-31 09:18:38.716576 :C707FBF7:db_trace:kso.c@4113:ksonfy(): [10420:22:0] kso: spawn diagnostics: exec time=0 secs 2025-08-31 09:18:38.716576 :C707FBF8:db_trace:kso.c@4115:ksonfy(): [10420:22:0] kso: spawn diagnostics: pre dbkc time=0 secs 2025-08-31 09:18:38.716577 :C707FBF9:db_trace:kso.c@4117:ksonfy(): [10420:22:0] kso: spawn diagnostics: post dbkc time=0 secs 2025-08-31 09:18:38.717079 :C707FBFA: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-08-31 09:18:38.717125 :C707FC02: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-08-31 09:20:56.216547 :C70828CE: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-08-31 09:28:39.904609 :C708C280: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-08-31 09:38:40.649772 :C70988F8:db_trace:kst.c@698:kstpsodel(): [10280:22:0] kst: process state object about to be deleted 2025-08-31 09:38:41.092002 :C709892E:db_trace:kst.c@673:kstipg(): [10280:22:0] kst: process state object created on 08-31 09:38:41.087 2025-08-31 09:38:41.092004 :C709892F:db_trace:kst.c@679:kstipg(): [10280:22:0] kst: process info: ospid=20860 pso_num=22 pso_serial#=223 2025-08-31 09:38:41.092147 :C7098930:db_trace:kso.c@4093:ksonfy(): [10420:22:0] kso: new process: pid=20860 osp_idx=0 osp_ver=557980 osp_pg=0 (spawn #544116) 2025-08-31 09:38:41.092148 :C7098931:db_trace:kso.c@4099:ksonfy(): [10420:22:0] kso: new process: first_req_pid=1236 spawner_pid=3660 sga_crt_ts=x8A8A 2025-08-31 09:38:41.092148 :C7098932:db_trace:kso.c@4103:ksonfy(): [10420:22:0] kso: new process: pso_index=22 reservation=3 time=1018772393 2025-08-31 09:38:41.092148 :C7098933:db_trace:kso.c@4109:ksonfy(): [10420:22:0] kso: spawn diagnostics: queue time=0 secs 2025-08-31 09:38:41.092148 :C7098934:db_trace:kso.c@4111:ksonfy(): [10420:22:0] kso: spawn diagnostics: fork time=0 secs 2025-08-31 09:38:41.092149 :C7098935:db_trace:kso.c@4113:ksonfy(): [10420:22:0] kso: spawn diagnostics: exec time=0 secs 2025-08-31 09:38:41.092149 :C7098936:db_trace:kso.c@4115:ksonfy(): [10420:22:0] kso: spawn diagnostics: pre dbkc time=0 secs 2025-08-31 09:38:41.092150 :C7098937:db_trace:kso.c@4117:ksonfy(): [10420:22:0] kso: spawn diagnostics: post dbkc time=0 secs 2025-08-31 09:38:41.092649 :C7098938: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-08-31 09:38:41.092694 :C7098940: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-08-31 09:48:41.846716 :C70A4F0B:db_trace:kst.c@698:kstpsodel(): [10280:22:0] kst: process state object about to be deleted 2025-08-31 09:48:42.335838 :C70A4F4A:db_trace:kst.c@673:kstipg(): [10280:22:0] kst: process state object created on 08-31 09:48:42.331 2025-08-31 09:48:42.335840 :C70A4F4B:db_trace:kst.c@679:kstipg(): [10280:22:0] kst: process info: ospid=19972 pso_num=22 pso_serial#=224 2025-08-31 09:48:42.335973 :C70A4F4C:db_trace:kso.c@4093:ksonfy(): [10420:22:0] kso: new process: pid=19972 osp_idx=0 osp_ver=557981 osp_pg=0 (spawn #544139) 2025-08-31 09:48:42.335974 :C70A4F4D:db_trace:kso.c@4099:ksonfy(): [10420:22:0] kso: new process: first_req_pid=1236 spawner_pid=3660 sga_crt_ts=x8A8A 2025-08-31 09:48:42.335974 :C70A4F4E:db_trace:kso.c@4103:ksonfy(): [10420:22:0] kso: new process: pso_index=22 reservation=4 time=1019373643 2025-08-31 09:48:42.335975 :C70A4F4F:db_trace:kso.c@4109:ksonfy(): [10420:22:0] kso: spawn diagnostics: queue time=0 secs 2025-08-31 09:48:42.335975 :C70A4F50:db_trace:kso.c@4111:ksonfy(): [10420:22:0] kso: spawn diagnostics: fork time=0 secs 2025-08-31 09:48:42.335975 :C70A4F51:db_trace:kso.c@4113:ksonfy(): [10420:22:0] kso: spawn diagnostics: exec time=0 secs 2025-08-31 09:48:42.335976 :C70A4F52:db_trace:kso.c@4115:ksonfy(): [10420:22:0] kso: spawn diagnostics: pre dbkc time=0 secs 2025-08-31 09:48:42.335976 :C70A4F53:db_trace:kso.c@4117:ksonfy(): [10420:22:0] kso: spawn diagnostics: post dbkc time=0 secs 2025-08-31 09:48:42.336470 :C70A4F54: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-08-31 09:48:42.336512 :C70A4F5B: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-08-31 09:58:43.200940 :C70B1561:db_trace:kst.c@698:kstpsodel(): [10280:22:0] kst: process state object about to be deleted 2025-08-31 09:58:43.518112 :C70B159A:db_trace:kst.c@673:kstipg(): [10280:22:0] kst: process state object created on 08-31 09:58:43.513 2025-08-31 09:58:43.518114 :C70B159B:db_trace:kst.c@679:kstipg(): [10280:22:0] kst: process info: ospid=23144 pso_num=22 pso_serial#=225 2025-08-31 09:58:43.518261 :C70B159C:db_trace:kso.c@4093:ksonfy(): [10420:22:0] kso: new process: pid=23144 osp_idx=0 osp_ver=557982 osp_pg=0 (spawn #544161) 2025-08-31 09:58:43.518262 :C70B159D:db_trace:kso.c@4099:ksonfy(): [10420:22:0] kso: new process: first_req_pid=1236 spawner_pid=3660 sga_crt_ts=x8A8A 2025-08-31 09:58:43.518263 :C70B159E:db_trace:kso.c@4103:ksonfy(): [10420:22:0] kso: new process: pso_index=22 reservation=5 time=1019974815 2025-08-31 09:58:43.518263 :C70B159F:db_trace:kso.c@4109:ksonfy(): [10420:22:0] kso: spawn diagnostics: queue time=0 secs 2025-08-31 09:58:43.518263 :C70B15A0:db_trace:kso.c@4111:ksonfy(): [10420:22:0] kso: spawn diagnostics: fork time=0 secs 2025-08-31 09:58:43.518264 :C70B15A1:db_trace:kso.c@4113:ksonfy(): [10420:22:0] kso: spawn diagnostics: exec time=0 secs 2025-08-31 09:58:43.518264 :C70B15A2:db_trace:kso.c@4115:ksonfy(): [10420:22:0] kso: spawn diagnostics: pre dbkc time=0 secs 2025-08-31 09:58:43.518264 :C70B15A3:db_trace:kso.c@4117:ksonfy(): [10420:22:0] kso: spawn diagnostics: post dbkc time=0 secs 2025-08-31 09:58:43.518772 :C70B15A4: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-08-31 09:58:43.518816 :C70B15AB: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: 23144, W000)
Ms-Dos/Windows
Unix
Write backup
jsp File Browser version 1.2 by
www.vonloesch.de