Trace file d:\app\administrator\diag\rdbms\orcl\orcl\trace\cdmp_20250903221927\orcl_ora_21880_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:35089M/63366M, Ph+PgF:39971M/72582M Instance name: orcl Redo thread mounted by this instance: 1 Oracle process number: 31 Windows thread id: 21880, image: ORACLE.EXE (SHAD) *** 2025-09-03 22:19:27.745 *** 2025-09-03 22:19:27.745 Process diagnostic dump for ORACLE.EXE (SHAD), OS id=21880, pid: 31, proc_ser: 169, sid: ------------------------------------------------------------------------------- Skipping session state dump because target process has no session. ------------------------------------------------------------------------------- Process diagnostic dump actual duration=0.000000 sec (max dump time=30.000000 sec) *** 2025-09-03 22:19:27.745 ------------------------------------------------------------------------------- Trace Bucket Dump Begin: default bucket for process 31 (osid: 21880) TIME(*=approx):SEQ:COMPONENT:FILE@LINE:FUNCTION:SECT/DUMP: [EVENT#:PID:SID] DATA ------------------------------------------------------------------------------- 2025-08-30 23:59:46.868363 :C6DBCACF:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-08-31 00:00:19.947254 :C6DBD608:db_trace:kst.c@698:kstpsodel(): [10280:31:0] kst: process state object about to be deleted 2025-08-31 06:00:00.355066 :C6F7E93A:db_trace:kst.c@673:kstipg(): [10280:31:0] kst: process state object created on 08-31 06:00:00.353 2025-08-31 06:00:00.355068 :C6F7E93B:db_trace:kst.c@679:kstipg(): [10280:31:0] kst: process info: ospid=19356 pso_num=31 pso_serial#=148 2025-08-31 06:00:00.355220 :C6F7E940:db_trace:kso.c@4093:ksonfy(): [10420:31:0] kso: new process: pid=19356 osp_idx=29 osp_ver=912 osp_pg=0 (spawn #543605) 2025-08-31 06:00:00.355221 :C6F7E941:db_trace:kso.c@4099:ksonfy(): [10420:31:0] kso: new process: first_req_pid=4308 spawner_pid=3660 sga_crt_ts=x8A8A 2025-08-31 06:00:00.355222 :C6F7E942:db_trace:kso.c@4103:ksonfy(): [10420:31:0] kso: new process: pso_index=31 reservation=11 time=1005651643 2025-08-31 06:00:00.355222 :C6F7E943:db_trace:kso.c@4109:ksonfy(): [10420:31:0] kso: spawn diagnostics: queue time=0 secs 2025-08-31 06:00:00.355223 :C6F7E944:db_trace:kso.c@4111:ksonfy(): [10420:31:0] kso: spawn diagnostics: fork time=0 secs 2025-08-31 06:00:00.355224 :C6F7E945:db_trace:kso.c@4113:ksonfy(): [10420:31:0] kso: spawn diagnostics: exec time=0 secs 2025-08-31 06:00:00.355224 :C6F7E946:db_trace:kso.c@4115:ksonfy(): [10420:31:0] kso: spawn diagnostics: pre dbkc time=0 secs 2025-08-31 06:00:00.355224 :C6F7E947:db_trace:kso.c@4117:ksonfy(): [10420:31:0] kso: spawn diagnostics: post dbkc time=0 secs 2025-08-31 06:00:00.355763 :C6F7E94D:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=59 loc='kso2.h LINE:416 ID:ksoreq_reply' id1=0 id2=0 name= type=0 2025-08-31 06:00:30.445432 :C6F7FC4F:db_trace:kst.c@698:kstpsodel(): [10280:31:0] kst: process state object about to be deleted 2025-08-31 23:59:10.160061 :C74D099D:db_trace:kst.c@673:kstipg(): [10280:31:0] kst: process state object created on 08-31 23:59:10.151 2025-08-31 23:59:10.160063 :C74D099E:db_trace:kst.c@679:kstipg(): [10280:31:0] kst: process info: ospid=17404 pso_num=31 pso_serial#=149 2025-08-31 23:59:10.160215 :C74D099F:db_trace:kso.c@4070:ksonfy(): [10420:31:0] kso: new process: pid=17404 (legacy spawn) 2025-08-31 23:59:10.175531 :C74D09A0:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-08-31 23:59:13.439902 :C74D0AB7:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-08-31 23:59:13.440098 :C74D0ABC:db_trace:ksl2.c@12699:ksliwat(): [10005:31:249] 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-08-31 23:59:13.441301 :C74D0AC1:db_trace:kst.c@698:kstpsodel(): [10280:31:0] kst: process state object about to be deleted 2025-08-31 23:59:18.381041 :C74D0C90:db_trace:kst.c@673:kstipg(): [10280:31:0] kst: process state object created on 08-31 23:59:18.379 2025-08-31 23:59:18.381044 :C74D0C91:db_trace:kst.c@679:kstipg(): [10280:31:0] kst: process info: ospid=23108 pso_num=31 pso_serial#=150 2025-08-31 23:59:18.381194 :C74D0C92:db_trace:kso.c@4070:ksonfy(): [10420:31:0] kso: new process: pid=23108 (legacy spawn) 2025-08-31 23:59:18.397741 :C74D0C93:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-08-31 23:59:21.677565 :C74D0D8E:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-08-31 23:59:21.677593 :C74D0D91:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-08-31 23:59:21.677744 :C74D0D94:db_trace:ksl2.c@12699:ksliwat(): [10005:31:249] 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-08-31 23:59:21.678969 :C74D0DA5:db_trace:kst.c@698:kstpsodel(): [10280:31:0] kst: process state object about to be deleted 2025-08-31 23:59:21.936371 :C74D0DD1:db_trace:kst.c@673:kstipg(): [10280:31:0] kst: process state object created on 08-31 23:59:21.923 2025-08-31 23:59:21.936373 :C74D0DD2:db_trace:kst.c@679:kstipg(): [10280:31:0] kst: process info: ospid=22656 pso_num=31 pso_serial#=151 2025-08-31 23:59:21.936513 :C74D0DD3:db_trace:kso.c@4070:ksonfy(): [10420:31:0] kso: new process: pid=22656 (legacy spawn) 2025-08-31 23:59:21.951360 :C74D0DD4:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-08-31 23:59:55.056889 :C74D19DE:db_trace:kst.c@698:kstpsodel(): [10280:31:0] kst: process state object about to be deleted 2025-08-31 23:59:55.736292 :C74D1A1D:db_trace:kst.c@673:kstipg(): [10280:31:0] kst: process state object created on 08-31 23:59:55.736 2025-08-31 23:59:55.736293 :C74D1A1E:db_trace:kst.c@679:kstipg(): [10280:31:0] kst: process info: ospid=21140 pso_num=31 pso_serial#=152 2025-08-31 23:59:55.736433 :C74D1A1F:db_trace:kso.c@4070:ksonfy(): [10420:31:0] kso: new process: pid=21140 (legacy spawn) 2025-08-31 23:59:55.750438 :C74D1A20:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-09-01 00:00:28.872172 :C74D2604:db_trace:kst.c@698:kstpsodel(): [10280:31:0] kst: process state object about to be deleted 2025-09-01 22:00:01.816908 :C7B52D49:db_trace:kst.c@673:kstipg(): [10280:31:0] kst: process state object created on 09-01 22:00:01.809 2025-09-01 22:00:01.816909 :C7B52D4A:db_trace:kst.c@679:kstipg(): [10280:31:0] kst: process info: ospid=23460 pso_num=31 pso_serial#=153 2025-09-01 22:00:01.817047 :C7B52D4B:db_trace:kso.c@4093:ksonfy(): [10420:31:0] kso: new process: pid=23460 osp_idx=29 osp_ver=917 osp_pg=0 (spawn #549164) 2025-09-01 22:00:01.817048 :C7B52D4C:db_trace:kso.c@4099:ksonfy(): [10420:31:0] kso: new process: first_req_pid=4308 spawner_pid=3660 sga_crt_ts=x8A8A 2025-09-01 22:00:01.817049 :C7B52D4D:db_trace:kso.c@4103:ksonfy(): [10420:31:0] kso: new process: pso_index=31 reservation=12 time=1149653112 2025-09-01 22:00:01.817050 :C7B52D4E:db_trace:kso.c@4109:ksonfy(): [10420:31:0] kso: spawn diagnostics: queue time=0 secs 2025-09-01 22:00:01.817050 :C7B52D4F:db_trace:kso.c@4111:ksonfy(): [10420:31:0] kso: spawn diagnostics: fork time=0 secs 2025-09-01 22:00:01.817050 :C7B52D50:db_trace:kso.c@4113:ksonfy(): [10420:31:0] kso: spawn diagnostics: exec time=0 secs 2025-09-01 22:00:01.817051 :C7B52D51:db_trace:kso.c@4115:ksonfy(): [10420:31:0] kso: spawn diagnostics: pre dbkc time=0 secs 2025-09-01 22:00:01.817051 :C7B52D52:db_trace:kso.c@4117:ksonfy(): [10420:31:0] kso: spawn diagnostics: post dbkc time=0 secs 2025-09-01 22:00:01.817741 :C7B52D53:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=59 loc='kso2.h LINE:416 ID:ksoreq_reply' id1=0 id2=0 name= type=0 2025-09-01 22:00:31.906756 :C7B54156:db_trace:kst.c@698:kstpsodel(): [10280:31:0] kst: process state object about to be deleted 2025-09-01 23:59:10.029403 :C7BF59EE:db_trace:kst.c@673:kstipg(): [10280:31:0] kst: process state object created on 09-01 23:59:10.020 2025-09-01 23:59:10.029405 :C7BF59EF:db_trace:kst.c@679:kstipg(): [10280:31:0] kst: process info: ospid=23076 pso_num=31 pso_serial#=154 2025-09-01 23:59:10.029551 :C7BF59F0:db_trace:kso.c@4070:ksonfy(): [10420:31:0] kso: new process: pid=23076 (legacy spawn) 2025-09-01 23:59:10.044030 :C7BF59F1:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-09-01 23:59:43.541389 :C7BF66B5:db_trace:kst.c@698:kstpsodel(): [10280:31:0] kst: process state object about to be deleted 2025-09-01 23:59:45.298795 :C7BF6768:db_trace:kst.c@673:kstipg(): [10280:31:0] kst: process state object created on 09-01 23:59:45.289 2025-09-01 23:59:45.298796 :C7BF6769:db_trace:kst.c@679:kstipg(): [10280:31:0] kst: process info: ospid=22072 pso_num=31 pso_serial#=155 2025-09-01 23:59:45.298942 :C7BF676A:db_trace:kso.c@4070:ksonfy(): [10420:31:0] kso: new process: pid=22072 (legacy spawn) 2025-09-01 23:59:45.313284 :C7BF676B:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-09-02 00:00:18.349164 :C7BF7357:db_trace:kst.c@698:kstpsodel(): [10280:31:0] kst: process state object about to be deleted 2025-09-02 22:00:01.171048 :C827AA69:db_trace:kst.c@673:kstipg(): [10280:31:0] kst: process state object created on 09-02 22:00:01.163 2025-09-02 22:00:01.171049 :C827AA6A:db_trace:kst.c@679:kstipg(): [10280:31:0] kst: process info: ospid=19796 pso_num=31 pso_serial#=156 2025-09-02 22:00:01.171181 :C827AA6B:db_trace:kso.c@4093:ksonfy(): [10420:31:0] kso: new process: pid=19796 osp_idx=29 osp_ver=920 osp_pg=0 (spawn #552495) 2025-09-02 22:00:01.171181 :C827AA6C:db_trace:kso.c@4099:ksonfy(): [10420:31:0] kso: new process: first_req_pid=4308 spawner_pid=3660 sga_crt_ts=x8A8A 2025-09-02 22:00:01.171182 :C827AA6D:db_trace:kso.c@4103:ksonfy(): [10420:31:0] kso: new process: pso_index=31 reservation=13 time=1236052471 2025-09-02 22:00:01.171182 :C827AA6E:db_trace:kso.c@4109:ksonfy(): [10420:31:0] kso: spawn diagnostics: queue time=0 secs 2025-09-02 22:00:01.171183 :C827AA6F:db_trace:kso.c@4111:ksonfy(): [10420:31:0] kso: spawn diagnostics: fork time=0 secs 2025-09-02 22:00:01.171183 :C827AA70:db_trace:kso.c@4113:ksonfy(): [10420:31:0] kso: spawn diagnostics: exec time=0 secs 2025-09-02 22:00:01.171184 :C827AA71:db_trace:kso.c@4115:ksonfy(): [10420:31:0] kso: spawn diagnostics: pre dbkc time=0 secs 2025-09-02 22:00:01.171184 :C827AA72:db_trace:kso.c@4117:ksonfy(): [10420:31:0] kso: spawn diagnostics: post dbkc time=0 secs 2025-09-02 22:00:01.171814 :C827AA7B:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=59 loc='kso2.h LINE:416 ID:ksoreq_reply' id1=0 id2=0 name= type=0 2025-09-02 22:00:31.246996 :C827BCD4:db_trace:kst.c@698:kstpsodel(): [10280:31:0] kst: process state object about to be deleted 2025-09-02 23:59:06.492951 :C83193DF:db_trace:kst.c@673:kstipg(): [10280:31:0] kst: process state object created on 09-02 23:59:06.478 2025-09-02 23:59:06.492953 :C83193E0:db_trace:kst.c@679:kstipg(): [10280:31:0] kst: process info: ospid=22852 pso_num=31 pso_serial#=157 2025-09-02 23:59:06.493096 :C83193E1:db_trace:kso.c@4070:ksonfy(): [10420:31:0] kso: new process: pid=22852 (legacy spawn) 2025-09-02 23:59:06.499646 :C83193E2:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-09-02 23:59:06.499829 :C83193E7:db_trace:ksl2.c@12699:ksliwat(): [10005:31:249] 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-09-02 23:59:06.500617 :C83193EC:db_trace:kst.c@698:kstpsodel(): [10280:31:0] kst: process state object about to be deleted 2025-09-02 23:59:06.509384 :C83193EF:db_trace:kst.c@673:kstipg(): [10280:31:0] kst: process state object created on 09-02 23:59:06.509 2025-09-02 23:59:06.509386 :C83193F0:db_trace:kst.c@679:kstipg(): [10280:31:0] kst: process info: ospid=20744 pso_num=31 pso_serial#=158 2025-09-02 23:59:06.509528 :C83193F1:db_trace:kso.c@4070:ksonfy(): [10420:31:0] kso: new process: pid=20744 (legacy spawn) 2025-09-02 23:59:06.516061 :C83193F2:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-09-02 23:59:06.516230 :C83193FA:db_trace:ksl2.c@12699:ksliwat(): [10005:31:249] 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-09-02 23:59:06.517042 :C83193FC:db_trace:kst.c@698:kstpsodel(): [10280:31:0] kst: process state object about to be deleted 2025-09-02 23:59:09.590375 :C8319502:db_trace:kst.c@673:kstipg(): [10280:31:0] kst: process state object created on 09-02 23:59:09.576 2025-09-02 23:59:09.590377 :C8319503:db_trace:kst.c@679:kstipg(): [10280:31:0] kst: process info: ospid=7436 pso_num=31 pso_serial#=159 2025-09-02 23:59:09.590572 :C8319504:db_trace:kso.c@4070:ksonfy(): [10420:31:0] kso: new process: pid=7436 (legacy spawn) 2025-09-02 23:59:09.597694 :C8319505:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-09-02 23:59:09.597883 :C831950E:db_trace:ksl2.c@12699:ksliwat(): [10005:31:249] 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-09-02 23:59:09.598768 :C831950F:db_trace:kst.c@698:kstpsodel(): [10280:31:0] kst: process state object about to be deleted 2025-09-02 23:59:09.608042 :C8319512:db_trace:kst.c@673:kstipg(): [10280:31:0] kst: process state object created on 09-02 23:59:09.607 2025-09-02 23:59:09.608044 :C8319513:db_trace:kst.c@679:kstipg(): [10280:31:0] kst: process info: ospid=22644 pso_num=31 pso_serial#=160 2025-09-02 23:59:09.608188 :C8319514:db_trace:kso.c@4070:ksonfy(): [10420:31:0] kso: new process: pid=22644 (legacy spawn) 2025-09-02 23:59:09.615066 :C8319515:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-09-02 23:59:09.615242 :C831951D:db_trace:ksl2.c@12699:ksliwat(): [10005:31:249] 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-09-02 23:59:09.616099 :C831951F:db_trace:kst.c@698:kstpsodel(): [10280:31:0] kst: process state object about to be deleted 2025-09-02 23:59:09.864009 :C8319561:db_trace:kst.c@673:kstipg(): [10280:31:0] kst: process state object created on 09-02 23:59:09.857 2025-09-02 23:59:09.864011 :C8319562:db_trace:kst.c@679:kstipg(): [10280:31:0] kst: process info: ospid=20048 pso_num=31 pso_serial#=161 2025-09-02 23:59:09.864158 :C8319563:db_trace:kso.c@4070:ksonfy(): [10420:31:0] kso: new process: pid=20048 (legacy spawn) 2025-09-02 23:59:09.878971 :C8319564:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-09-02 23:59:13.181686 :C8319686:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-09-02 23:59:13.181854 :C831968B:db_trace:ksl2.c@12699:ksliwat(): [10005:31:249] 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-09-02 23:59:13.183068 :C8319690:db_trace:kst.c@698:kstpsodel(): [10280:31:0] kst: process state object about to be deleted 2025-09-02 23:59:15.434139 :C8319733:db_trace:kst.c@673:kstipg(): [10280:31:0] kst: process state object created on 09-02 23:59:15.425 2025-09-02 23:59:15.434141 :C8319734:db_trace:kst.c@679:kstipg(): [10280:31:0] kst: process info: ospid=22668 pso_num=31 pso_serial#=162 2025-09-02 23:59:15.434280 :C8319735:db_trace:kso.c@4070:ksonfy(): [10420:31:0] kso: new process: pid=22668 (legacy spawn) 2025-09-02 23:59:15.440928 :C8319736:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-09-02 23:59:15.441115 :C831973B:db_trace:ksl2.c@12699:ksliwat(): [10005:31:249] 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-09-02 23:59:15.441968 :C8319740:db_trace:kst.c@698:kstpsodel(): [10280:31:0] kst: process state object about to be deleted 2025-09-02 23:59:18.272154 :C8319819:db_trace:kst.c@673:kstipg(): [10280:31:0] kst: process state object created on 09-02 23:59:18.260 2025-09-02 23:59:18.272156 :C831981A:db_trace:kst.c@679:kstipg(): [10280:31:0] kst: process info: ospid=20744 pso_num=31 pso_serial#=163 2025-09-02 23:59:18.272298 :C831981B:db_trace:kso.c@4070:ksonfy(): [10420:31:0] kso: new process: pid=20744 (legacy spawn) 2025-09-02 23:59:18.287243 :C8319849:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-09-02 23:59:51.446199 :C831A4A4:db_trace:kst.c@698:kstpsodel(): [10280:31:0] kst: process state object about to be deleted 2025-09-02 23:59:55.199879 :C831A605:db_trace:kst.c@673:kstipg(): [10280:31:0] kst: process state object created on 09-02 23:59:55.195 2025-09-02 23:59:55.199881 :C831A606:db_trace:kst.c@679:kstipg(): [10280:31:0] kst: process info: ospid=19060 pso_num=31 pso_serial#=164 2025-09-02 23:59:55.200064 :C831A607:db_trace:kso.c@4070:ksonfy(): [10420:31:0] kso: new process: pid=19060 (legacy spawn) 2025-09-02 23:59:55.215918 :C831A608:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-09-03 00:00:28.294880 :C831B226:db_trace:kst.c@698:kstpsodel(): [10280:31:0] kst: process state object about to be deleted 2025-09-03 22:00:04.866194 :C899AD6A:db_trace:kst.c@673:kstipg(): [10280:31:0] kst: process state object created on 09-03 22:00:04.861 2025-09-03 22:00:04.866196 :C899AD6B:db_trace:kst.c@679:kstipg(): [10280:31:0] kst: process info: ospid=13816 pso_num=31 pso_serial#=165 2025-09-03 22:00:04.866329 :C899AD6C:db_trace:kso.c@4093:ksonfy(): [10420:31:0] kso: new process: pid=13816 osp_idx=29 osp_ver=929 osp_pg=0 (spawn #555821) 2025-09-03 22:00:04.866330 :C899AD6D:db_trace:kso.c@4099:ksonfy(): [10420:31:0] kso: new process: first_req_pid=3704 spawner_pid=3660 sga_crt_ts=x8A8A 2025-09-03 22:00:04.866330 :C899AD6E:db_trace:kso.c@4103:ksonfy(): [10420:31:0] kso: new process: pso_index=31 reservation=14 time=1322456174 2025-09-03 22:00:04.866331 :C899AD6F:db_trace:kso.c@4109:ksonfy(): [10420:31:0] kso: spawn diagnostics: queue time=0 secs 2025-09-03 22:00:04.866331 :C899AD70:db_trace:kso.c@4111:ksonfy(): [10420:31:0] kso: spawn diagnostics: fork time=0 secs 2025-09-03 22:00:04.866331 :C899AD71:db_trace:kso.c@4113:ksonfy(): [10420:31:0] kso: spawn diagnostics: exec time=0 secs 2025-09-03 22:00:04.866332 :C899AD72:db_trace:kso.c@4115:ksonfy(): [10420:31:0] kso: spawn diagnostics: pre dbkc time=0 secs 2025-09-03 22:00:04.866332 :C899AD73:db_trace:kso.c@4117:ksonfy(): [10420:31:0] kso: spawn diagnostics: post dbkc time=0 secs 2025-09-03 22:00:04.866880 :C899AD74:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=18 loc='kso2.h LINE:416 ID:ksoreq_reply' id1=0 id2=0 name= type=0 2025-09-03 22:00:04.866924 :C899AD7B:db_trace:ksl2.c@12699:ksliwat(): [10005:31:249] KSL POST RCVD poster=18 loc='ksv2.h LINE:1639 ID:ksvpst: run' id1=0 id2=0 name= type=0 fac#=0 facpost=1 2025-09-03 22:00:04.871508 :C899AD91:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-09-03 22:00:04.894269 :C899ADA7:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-09-03 22:00:04.909127 :C899ADB9:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-09-03 22:00:04.941712 :C899ADC1:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-09-03 22:00:04.945507 :C899ADC9:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-09-03 22:00:04.949194 :C899ADD1:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-09-03 22:00:04.953504 :C899ADD9:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-09-03 22:00:04.954597 :C899ADE1:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-09-03 22:00:05.970442*:C899AE6C:sql_mon_query:keswx.c@6099:keswxCurPushMonitoring(begin): xsc=0x00000000326D15D0 estart=1756908004 eid=16781185 ctx=0x000000077BA4B1C8 cwh=0x0000000032090500 cpu=406250 buffg=0 interb=0 r=0 rb=0 w=0 wb=0 2025-09-03 22:00:05.970442*:C899AE6D:sql_mon_query:keswx.c@2839:keswxCurPrepare(): Allocate monitor context: xsc=0x00000000326D15D0 curCtx=0x00000000326CF9B8 pubTabIdxCnt=0 2025-09-03 22:00:05.970442*:C899AE6E:sql_mon_query:keswx.c@6131:keswxCurPushMonitoring(): clear monitoring flag for xsc=0x00000000326D15D0 2025-09-03 22:00:05.970442*:C899AE6F:sql_mon_query:keswx.c@6263:keswxCurPushMonitoring(end): full monitoring not yet started for xsc=0x00000000326D15D0 2025-09-03 22:00:05.970442*:C899AE70:sql_mon_query:keswx.c@6099:keswxCurPushMonitoring(begin): xsc=0x00000000320A1E80 estart=1756908004 eid=16781162 ctx=0x0000000787AD5BF0 cwh=0x00000000320907D0 cpu=406250 buffg=0 interb=0 r=0 rb=0 w=0 wb=0 2025-09-03 22:00:05.970442*:C899AE71:sql_mon_query:keswx.c@2839:keswxCurPrepare(): Allocate monitor context: xsc=0x00000000320A1E80 curCtx=0x00000000326D2570 pubTabIdxCnt=0 2025-09-03 22:00:05.970442*:C899AE72:sql_mon_query:keswx.c@6131:keswxCurPushMonitoring(): clear monitoring flag for xsc=0x00000000320A1E80 2025-09-03 22:00:05.970442*:C899AE73:sql_mon_query:keswx.c@6263:keswxCurPushMonitoring(end): full monitoring not yet started for xsc=0x00000000320A1E80 2025-09-03 22:00:06.095428*:C899AE74:sql_mon_query:keswx.c@3282:keswxCurEndPlanMonitoringCb(begin): xsc=0x00000000326D15D0 curCtx=0x00000000326CF9B8 xsc->flg4=65792 flags=1 2025-09-03 22:00:06.095428*:C899AE75:sql_mon_query:keswx.c@3389:keswxCurEndPlanMonitoringCb(end): monitoring has ended for xsc=0x00000000326D15D0 2025-09-03 22:00:06.095428*:C899AE76:sql_mon_query:keswx.c@3282:keswxCurEndPlanMonitoringCb(begin): xsc=0x00000000320A1E80 curCtx=0x00000000326D2570 xsc->flg4=65792 flags=2 2025-09-03 22:00:06.095428*:C899AE77:sql_mon_query:keswx.c@3389:keswxCurEndPlanMonitoringCb(end): monitoring has ended for xsc=0x00000000320A1E80 2025-09-03 22:00:06.163884 :C899AE78:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-09-03 22:00:06.216220 :C899AE80:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-09-03 22:00:06.216519 :C899AE88:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-09-03 22:00:06.216817 :C899AE90:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-09-03 22:00:06.216834 :C899AE93:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=18 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-09-03 22:00:06.216920 :C899AEA5:db_trace:ksl2.c@12699:ksliwat(): [10005:31:249] 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-09-03 22:00:06.221655 :C899AEAD:db_trace:kst.c@698:kstpsodel(): [10280:31:0] kst: process state object about to be deleted 2025-09-03 22:00:06.522655 :C899AF99:db_trace:kst.c@673:kstipg(): [10280:31:0] kst: process state object created on 09-03 22:00:06.517 2025-09-03 22:00:06.522657 :C899AF9A:db_trace:kst.c@679:kstipg(): [10280:31:0] kst: process info: ospid=24288 pso_num=31 pso_serial#=166 2025-09-03 22:00:06.522801 :C899AF9B:db_trace:kso.c@4070:ksonfy(): [10420:31:0] kso: new process: pid=24288 (legacy spawn) 2025-09-03 22:00:06.529944 :C899AF9C:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-09-03 22:00:06.530124 :C899AFA5:db_trace:ksl2.c@12699:ksliwat(): [10005:31:249] 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-09-03 22:00:06.531141 :C899AFA6:db_trace:kst.c@698:kstpsodel(): [10280:31:0] kst: process state object about to be deleted 2025-09-03 22:00:07.135967 :C899B05F:db_trace:kst.c@673:kstipg(): [10280:31:0] kst: process state object created on 09-03 22:00:07.127 2025-09-03 22:00:07.135969 :C899B060:db_trace:kst.c@679:kstipg(): [10280:31:0] kst: process info: ospid=23140 pso_num=31 pso_serial#=167 2025-09-03 22:00:07.136102 :C899B061:db_trace:kso.c@4070:ksonfy(): [10420:31:0] kso: new process: pid=23140 (legacy spawn) 2025-09-03 22:00:07.142687 :C899B066:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-09-03 22:00:07.142830 :C899B06F:db_trace:ksl2.c@12699:ksliwat(): [10005:31:249] 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-09-03 22:00:07.143603 :C899B070:db_trace:kst.c@698:kstpsodel(): [10280:31:0] kst: process state object about to be deleted 2025-09-03 22:00:07.500778 :C899B080:db_trace:kst.c@673:kstipg(): [10280:31:0] kst: process state object created on 09-03 22:00:07.486 2025-09-03 22:00:07.500780 :C899B081:db_trace:kst.c@679:kstipg(): [10280:31:0] kst: process info: ospid=11772 pso_num=31 pso_serial#=168 2025-09-03 22:00:07.500924 :C899B082:db_trace:kso.c@4070:ksonfy(): [10420:31:0] kso: new process: pid=11772 (legacy spawn) 2025-09-03 22:00:07.507598 :C899B083:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-09-03 22:00:07.507766 :C899B08C:db_trace:ksl2.c@12699:ksliwat(): [10005:31:249] 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-09-03 22:00:07.508584 :C899B08D:db_trace:kst.c@698:kstpsodel(): [10280:31:0] kst: process state object about to be deleted 2025-09-03 22:00:07.517262 :C899B090:db_trace:kst.c@673:kstipg(): [10280:31:0] kst: process state object created on 09-03 22:00:07.502 2025-09-03 22:00:07.517264 :C899B091:db_trace:kst.c@679:kstipg(): [10280:31:0] kst: process info: ospid=21880 pso_num=31 pso_serial#=169 2025-09-03 22:00:07.517414 :C899B092:db_trace:kso.c@4070:ksonfy(): [10420:31:0] kso: new process: pid=21880 (legacy spawn) 2025-09-03 22:00:07.523846 :C899B093:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-09-03 22:00:07.524001 :C899B09C:db_trace:ksl2.c@12699:ksliwat(): [10005:31:249] 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-09-03 22:00:07.524790 :C899B09D:db_trace:kst.c@698:kstpsodel(): [10280:31:0] kst: process state object about to be deleted ------------------------------------------------------------------------------- Trace Bucket Dump End: default bucket for process 31 (osid: 21880)