Trace file d:\app\administrator\diag\rdbms\orcl\orcl\trace\cdmp_20250822220008\orcl_j003_20016_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:35305M/63366M, Ph+PgF:40477M/72582M Instance name: orcl Redo thread mounted by this instance: 1 Oracle process number: 29 Windows thread id: 20016, image: ORACLE.EXE (J003) *** 2025-08-22 22:00:08.732 *** 2025-08-22 22:00:08.732 Process diagnostic dump for ORACLE.EXE (J003), OS id=20016, pid: 29, proc_ser: 180, 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-08-22 22:00:08.732 ------------------------------------------------------------------------------- Trace Bucket Dump Begin: default bucket for process 29 (osid: 20016, J003) TIME(*=approx):SEQ:COMPONENT:FILE@LINE:FUNCTION:SECT/DUMP: [EVENT#:PID:SID] DATA ------------------------------------------------------------------------------- 2025-08-22 01:00:05.058958 :C2EA6D79:db_trace:ksl2.c@12699:ksliwat(): [10005:29:233] 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-08-22 01:00:05.063415 :C2EA6D8C:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:29:233] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-08-22 01:00:05.085716 :C2EA6D94:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:29:233] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-08-22 01:00:05.100993 :C2EA6D9C:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:29:233] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-08-22 01:00:05.134766 :C2EA6DA4:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:29:233] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-08-22 01:00:05.138460 :C2EA6DAC:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:29:233] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-08-22 01:00:05.142122 :C2EA6DB4:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:29:233] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-08-22 01:00:05.146415 :C2EA6DBC:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:29:233] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-08-22 01:00:05.147561 :C2EA6DC4:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:29:233] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-08-22 01:00:06.298659*:C2EA6DEB:sql_mon_query:keswx.c@6099:keswxCurPushMonitoring(begin): xsc=0x000000002B4C1B88 estart=1755795605 eid=16780874 ctx=0x000000077BA4B1C8 cwh=0x000000002B420500 cpu=546875 buffg=0 interb=0 r=0 rb=0 w=0 wb=0 2025-08-22 01:00:06.298659*:C2EA6DEC:sql_mon_query:keswx.c@2839:keswxCurPrepare(): Allocate monitor context: xsc=0x000000002B4C1B88 curCtx=0x000000002B54F998 pubTabIdxCnt=0 2025-08-22 01:00:06.298659*:C2EA6DED:sql_mon_query:keswx.c@6131:keswxCurPushMonitoring(): clear monitoring flag for xsc=0x000000002B4C1B88 2025-08-22 01:00:06.298659*:C2EA6DEE:sql_mon_query:keswx.c@6263:keswxCurPushMonitoring(end): full monitoring not yet started for xsc=0x000000002B4C1B88 2025-08-22 01:00:06.298659*:C2EA6DEF:sql_mon_query:keswx.c@6099:keswxCurPushMonitoring(begin): xsc=0x000000002B433990 estart=1755795605 eid=16780853 ctx=0x0000000787AD5BF0 cwh=0x000000002B4207D0 cpu=546875 buffg=0 interb=0 r=0 rb=0 w=0 wb=0 2025-08-22 01:00:06.298659*:C2EA6DF0:sql_mon_query:keswx.c@2839:keswxCurPrepare(): Allocate monitor context: xsc=0x000000002B433990 curCtx=0x000000002B4C2B28 pubTabIdxCnt=0 2025-08-22 01:00:06.298659*:C2EA6DF1:sql_mon_query:keswx.c@6131:keswxCurPushMonitoring(): clear monitoring flag for xsc=0x000000002B433990 2025-08-22 01:00:06.298659*:C2EA6DF2:sql_mon_query:keswx.c@6263:keswxCurPushMonitoring(end): full monitoring not yet started for xsc=0x000000002B433990 2025-08-22 01:00:06.298659*:C2EA6DF3:sql_mon_query:keswx.c@3282:keswxCurEndPlanMonitoringCb(begin): xsc=0x000000002B4C1B88 curCtx=0x000000002B54F998 xsc->flg4=65792 flags=1 2025-08-22 01:00:06.298659*:C2EA6DF4:sql_mon_query:keswx.c@3389:keswxCurEndPlanMonitoringCb(end): monitoring has ended for xsc=0x000000002B4C1B88 2025-08-22 01:00:06.298659*:C2EA6DF5:sql_mon_query:keswx.c@3282:keswxCurEndPlanMonitoringCb(begin): xsc=0x000000002B433990 curCtx=0x000000002B4C2B28 xsc->flg4=65792 flags=2 2025-08-22 01:00:06.298659*:C2EA6DF6:sql_mon_query:keswx.c@3389:keswxCurEndPlanMonitoringCb(end): monitoring has ended for xsc=0x000000002B433990 2025-08-22 01:00:06.372803 :C2EA6DF7:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:29:233] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-08-22 01:00:06.419883 :C2EA6DFF:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:29:233] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-08-22 01:00:06.420217 :C2EA6E07:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:29:233] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-08-22 01:00:06.420498 :C2EA6E0F:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:29:233] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-08-22 01:00:06.420515 :C2EA6E12:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:29:233] KSL POST SENT postee=18 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-08-22 01:00:06.420578 :C2EA6E1E:db_trace:ksl2.c@12699:ksliwat(): [10005:29:233] 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-22 01:00:06.423357 :C2EA6E2C:db_trace:kst.c@698:kstpsodel(): [10280:29:0] kst: process state object about to be deleted 2025-08-22 01:00:14.924418 :C2EA7161:db_trace:kst.c@673:kstipg(): [10280:29:0] kst: process state object created on 08-22 01:00:14.911 2025-08-22 01:00:14.924420 :C2EA7162:db_trace:kst.c@679:kstipg(): [10280:29:0] kst: process info: ospid=20664 pso_num=29 pso_serial#=172 2025-08-22 01:00:14.924555 :C2EA7163:db_trace:kso.c@4070:ksonfy(): [10420:29:0] kso: new process: pid=20664 (legacy spawn) 2025-08-22 01:00:14.931065 :C2EA7164:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:29:233] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-08-22 01:00:14.931234 :C2EA7169:db_trace:ksl2.c@12699:ksliwat(): [10005:29:233] 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-22 01:00:14.932028 :C2EA716E:db_trace:kst.c@698:kstpsodel(): [10280:29:0] kst: process state object about to be deleted 2025-08-22 01:00:28.388049 :C2EA7578:db_trace:kst.c@673:kstipg(): [10280:29:0] kst: process state object created on 08-22 01:00:28.373 2025-08-22 01:00:28.388050 :C2EA7579:db_trace:kst.c@679:kstipg(): [10280:29:0] kst: process info: ospid=21252 pso_num=29 pso_serial#=173 2025-08-22 01:00:28.388187 :C2EA757A:db_trace:kso.c@4070:ksonfy(): [10420:29:0] kso: new process: pid=21252 (legacy spawn) 2025-08-22 01:00:28.394697 :C2EA757B:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:29:233] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-08-22 01:00:28.394875 :C2EA7581:db_trace:ksl2.c@12699:ksliwat(): [10005:29:233] 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-22 01:00:28.395670 :C2EA7585:db_trace:kst.c@698:kstpsodel(): [10280:29:0] kst: process state object about to be deleted 2025-08-22 01:00:28.413709 :C2EA7588:db_trace:kst.c@673:kstipg(): [10280:29:0] kst: process state object created on 08-22 01:00:28.405 2025-08-22 01:00:28.413712 :C2EA7589:db_trace:kst.c@679:kstipg(): [10280:29:0] kst: process info: ospid=16876 pso_num=29 pso_serial#=174 2025-08-22 01:00:28.413853 :C2EA758A:db_trace:kso.c@4070:ksonfy(): [10420:29:0] kso: new process: pid=16876 (legacy spawn) 2025-08-22 01:00:28.420440 :C2EA758B:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:29:233] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-08-22 01:00:28.420619 :C2EA7593:db_trace:ksl2.c@12699:ksliwat(): [10005:29:233] 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-22 01:00:28.421461 :C2EA7595:db_trace:kst.c@698:kstpsodel(): [10280:29:0] kst: process state object about to be deleted 2025-08-22 01:00:31.584095 :C2EA7682:db_trace:kst.c@673:kstipg(): [10280:29:0] kst: process state object created on 08-22 01:00:31.571 2025-08-22 01:00:31.584097 :C2EA7683:db_trace:kst.c@679:kstipg(): [10280:29:0] kst: process info: ospid=20408 pso_num=29 pso_serial#=175 2025-08-22 01:00:31.584238 :C2EA7684:db_trace:kso.c@4070:ksonfy(): [10420:29:0] kso: new process: pid=20408 (legacy spawn) 2025-08-22 01:00:31.590794 :C2EA7685:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:29:233] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-08-22 01:00:31.590970 :C2EA768A:db_trace:ksl2.c@12699:ksliwat(): [10005:29:233] 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-22 01:00:31.591851 :C2EA768F:db_trace:kst.c@698:kstpsodel(): [10280:29:0] kst: process state object about to be deleted 2025-08-22 01:00:31.600439 :C2EA7692:db_trace:kst.c@673:kstipg(): [10280:29:0] kst: process state object created on 08-22 01:00:31.587 2025-08-22 01:00:31.600442 :C2EA7693:db_trace:kst.c@679:kstipg(): [10280:29:0] kst: process info: ospid=21796 pso_num=29 pso_serial#=176 2025-08-22 01:00:31.600580 :C2EA7694:db_trace:kso.c@4070:ksonfy(): [10420:29:0] kso: new process: pid=21796 (legacy spawn) 2025-08-22 01:00:31.607082 :C2EA7695:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:29:233] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-08-22 01:00:31.607250 :C2EA769E:db_trace:ksl2.c@12699:ksliwat(): [10005:29:233] 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-22 01:00:31.608090 :C2EA769F:db_trace:kst.c@698:kstpsodel(): [10280:29:0] kst: process state object about to be deleted 2025-08-22 08:10:32.100664 :C30C3275:db_trace:kst.c@673:kstipg(): [10280:29:0] kst: process state object created on 08-22 08:10:32.096 2025-08-22 08:10:32.100665 :C30C3276:db_trace:kst.c@679:kstipg(): [10280:29:0] kst: process info: ospid=22044 pso_num=29 pso_serial#=177 2025-08-22 08:10:32.103283 :C30C3277:db_trace:kso.c@4093:ksonfy(): [10420:29:0] kso: new process: pid=22044 osp_idx=27 osp_ver=16241 osp_pg=0 (spawn #513895) 2025-08-22 08:10:32.103285 :C30C3278:db_trace:kso.c@4099:ksonfy(): [10420:29:0] kso: new process: first_req_pid=3704 spawner_pid=3660 sga_crt_ts=x8A8A 2025-08-22 08:10:32.103285 :C30C3279:db_trace:kso.c@4103:ksonfy(): [10420:29:0] kso: new process: pso_index=29 reservation=89 time=235934096 2025-08-22 08:10:32.103285 :C30C327A:db_trace:kso.c@4109:ksonfy(): [10420:29:0] kso: spawn diagnostics: queue time=0 secs 2025-08-22 08:10:32.103286 :C30C327B:db_trace:kso.c@4111:ksonfy(): [10420:29:0] kso: spawn diagnostics: fork time=0 secs 2025-08-22 08:10:32.103286 :C30C327C:db_trace:kso.c@4113:ksonfy(): [10420:29:0] kso: spawn diagnostics: exec time=0 secs 2025-08-22 08:10:32.103287 :C30C327D:db_trace:kso.c@4115:ksonfy(): [10420:29:0] kso: spawn diagnostics: pre dbkc time=0 secs 2025-08-22 08:10:32.103287 :C30C327E:db_trace:kso.c@4117:ksonfy(): [10420:29:0] kso: spawn diagnostics: post dbkc time=0 secs 2025-08-22 08:10:32.109634 :C30C327F:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:29:233] KSL POST SENT postee=18 loc='kso2.h LINE:416 ID:ksoreq_reply' id1=0 id2=0 name= type=0 2025-08-22 08:10:32.109682 :C30C3285:db_trace:ksl2.c@12699:ksliwat(): [10005:29:233] 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-08-22 08:10:32.110114 :C30C3286:db_trace:kst.c@698:kstpsodel(): [10280:29:0] kst: process state object about to be deleted 2025-08-22 08:10:34.376830 :C30C33F6:db_trace:kst.c@673:kstipg(): [10280:29:0] kst: process state object created on 08-22 08:10:34.361 2025-08-22 08:10:34.376831 :C30C33F7:db_trace:kst.c@679:kstipg(): [10280:29:0] kst: process info: ospid=21000 pso_num=29 pso_serial#=178 2025-08-22 08:10:34.376998 :C30C33F8:db_trace:kso.c@4093:ksonfy(): [10420:29:0] kso: new process: pid=21000 osp_idx=27 osp_ver=16242 osp_pg=0 (spawn #513897) 2025-08-22 08:10:34.376999 :C30C33F9:db_trace:kso.c@4099:ksonfy(): [10420:29:0] kso: new process: first_req_pid=3704 spawner_pid=3660 sga_crt_ts=x8A8A 2025-08-22 08:10:34.376999 :C30C33FA:db_trace:kso.c@4103:ksonfy(): [10420:29:0] kso: new process: pso_index=29 reservation=90 time=235936377 2025-08-22 08:10:34.376999 :C30C33FB:db_trace:kso.c@4109:ksonfy(): [10420:29:0] kso: spawn diagnostics: queue time=0 secs 2025-08-22 08:10:34.377000 :C30C33FC:db_trace:kso.c@4111:ksonfy(): [10420:29:0] kso: spawn diagnostics: fork time=0 secs 2025-08-22 08:10:34.377000 :C30C33FD:db_trace:kso.c@4113:ksonfy(): [10420:29:0] kso: spawn diagnostics: exec time=0 secs 2025-08-22 08:10:34.377001 :C30C33FE:db_trace:kso.c@4115:ksonfy(): [10420:29:0] kso: spawn diagnostics: pre dbkc time=0 secs 2025-08-22 08:10:34.377001 :C30C33FF:db_trace:kso.c@4117:ksonfy(): [10420:29:0] kso: spawn diagnostics: post dbkc time=0 secs 2025-08-22 08:10:34.377522 :C30C3400:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:29:233] KSL POST SENT postee=18 loc='kso2.h LINE:416 ID:ksoreq_reply' id1=0 id2=0 name= type=0 2025-08-22 08:10:34.377562 :C30C3406:db_trace:ksl2.c@12699:ksliwat(): [10005:29:233] 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-08-22 08:10:34.377939 :C30C3407:db_trace:kst.c@698:kstpsodel(): [10280:29:0] kst: process state object about to be deleted 2025-08-22 16:00:05.076773 :C330EEC6:db_trace:kst.c@673:kstipg(): [10280:29:0] kst: process state object created on 08-22 16:00:05.067 2025-08-22 16:00:05.076775 :C330EEC7:db_trace:kst.c@679:kstipg(): [10280:29:0] kst: process info: ospid=19336 pso_num=29 pso_serial#=179 2025-08-22 16:00:05.076908 :C330EEC8:db_trace:kso.c@4093:ksonfy(): [10420:29:0] kso: new process: pid=19336 osp_idx=27 osp_ver=16243 osp_pg=0 (spawn #514979) 2025-08-22 16:00:05.076908 :C330EEC9:db_trace:kso.c@4099:ksonfy(): [10420:29:0] kso: new process: first_req_pid=3704 spawner_pid=3660 sga_crt_ts=x8A8A 2025-08-22 16:00:05.076909 :C330EECA:db_trace:kso.c@4103:ksonfy(): [10420:29:0] kso: new process: pso_index=29 reservation=91 time=264107080 2025-08-22 16:00:05.076909 :C330EECB:db_trace:kso.c@4109:ksonfy(): [10420:29:0] kso: spawn diagnostics: queue time=0 secs 2025-08-22 16:00:05.076910 :C330EECC:db_trace:kso.c@4111:ksonfy(): [10420:29:0] kso: spawn diagnostics: fork time=0 secs 2025-08-22 16:00:05.076910 :C330EECD:db_trace:kso.c@4113:ksonfy(): [10420:29:0] kso: spawn diagnostics: exec time=0 secs 2025-08-22 16:00:05.076910 :C330EECE:db_trace:kso.c@4115:ksonfy(): [10420:29:0] kso: spawn diagnostics: pre dbkc time=0 secs 2025-08-22 16:00:05.076910 :C330EECF:db_trace:kso.c@4117:ksonfy(): [10420:29:0] kso: spawn diagnostics: post dbkc time=0 secs 2025-08-22 16:00:05.077411 :C330EED0:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:29:233] KSL POST SENT postee=18 loc='kso2.h LINE:416 ID:ksoreq_reply' id1=0 id2=0 name= type=0 2025-08-22 16:00:05.077465 :C330EED6:db_trace:ksl2.c@12699:ksliwat(): [10005:29:233] 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-08-22 16:00:05.079997 :C330EEE4:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:29:233] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-08-22 16:00:05.085657 :C330EEEC:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:29:233] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-08-22 16:00:05.086732 :C330EEF4:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:29:233] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-08-22 16:00:05.087207 :C330EEFC:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:29:233] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-08-22 16:00:05.087636 :C330EF04:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:29:233] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-08-22 16:00:05.088146 :C330EF0C:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:29:233] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-08-22 16:00:05.090622 :C330EF14:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:29:233] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-08-22 16:00:05.091661 :C330EF1C:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:29:233] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-08-22 16:00:05.141485 :C330EF24:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:29:233] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-08-22 16:00:05.142636 :C330EF2C:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:29:233] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-08-22 16:00:05.143496 :C330EF34:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:29:233] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-08-22 16:00:05.143724 :C330EF3C:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:29:233] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-08-22 16:00:05.143962 :C330EF44:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:29:233] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-08-22 16:00:05.145774 :C330EF4C:db_trace:kst.c@698:kstpsodel(): [10280:29:0] kst: process state object about to be deleted 2025-08-22 22:00:00.543619 :C34CC737:db_trace:kst.c@673:kstipg(): [10280:29:0] kst: process state object created on 08-22 22:00:00.532 2025-08-22 22:00:00.543622 :C34CC738:db_trace:kst.c@679:kstipg(): [10280:29:0] kst: process info: ospid=20016 pso_num=29 pso_serial#=180 2025-08-22 22:00:00.543783 :C34CC73A:db_trace:kso.c@4093:ksonfy(): [10420:29:0] kso: new process: pid=20016 osp_idx=27 osp_ver=16244 osp_pg=0 (spawn #515811) 2025-08-22 22:00:00.543783 :C34CC73B:db_trace:kso.c@4099:ksonfy(): [10420:29:0] kso: new process: first_req_pid=4308 spawner_pid=3660 sga_crt_ts=x8A8A 2025-08-22 22:00:00.543784 :C34CC73C:db_trace:kso.c@4103:ksonfy(): [10420:29:0] kso: new process: pso_index=29 reservation=92 time=285702549 2025-08-22 22:00:00.543784 :C34CC73D:db_trace:kso.c@4109:ksonfy(): [10420:29:0] kso: spawn diagnostics: queue time=0 secs 2025-08-22 22:00:00.543784 :C34CC73E:db_trace:kso.c@4111:ksonfy(): [10420:29:0] kso: spawn diagnostics: fork time=0 secs 2025-08-22 22:00:00.543785 :C34CC73F:db_trace:kso.c@4113:ksonfy(): [10420:29:0] kso: spawn diagnostics: exec time=0 secs 2025-08-22 22:00:00.543785 :C34CC740:db_trace:kso.c@4115:ksonfy(): [10420:29:0] kso: spawn diagnostics: pre dbkc time=0 secs 2025-08-22 22:00:00.543785 :C34CC741:db_trace:kso.c@4117:ksonfy(): [10420:29:0] kso: spawn diagnostics: post dbkc time=0 secs 2025-08-22 22:00:00.544352 :C34CC752:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:29:233] KSL POST SENT postee=59 loc='kso2.h LINE:416 ID:ksoreq_reply' id1=0 id2=0 name= type=0 2025-08-22 22:00:00.549619 :C34CC770:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:29:233] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-08-22 22:00:00.549652 :C34CC774:db_trace:ktc.c@8711:ktcAutoTxnTrace(): [10441:29:233] atxpus:jslv.c:9203 2025-08-22 22:00:00.567114 :C34CC950:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:29:233] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-08-22 22:00:00.567431 :C34CC958:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:29:233] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-08-22 22:00:00.567620 :C34CC960:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:29:233] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-08-22 22:00:00.567786 :C34CC968:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:29:233] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-08-22 22:00:00.567951 :C34CC970:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:29:233] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-08-22 22:00:00.568120 :C34CC978:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:29:233] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-08-22 22:00:00.568298 :C34CC980:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:29:233] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-08-22 22:00:00.568449 :C34CC988:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:29:233] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-08-22 22:00:00.568600 :C34CC990:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:29:233] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-08-22 22:00:00.568752 :C34CC998:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:29:233] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-08-22 22:00:00.568910 :C34CC9A0:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:29:233] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-08-22 22:00:00.569061 :C34CC9A8:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:29:233] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-08-22 22:00:00.569209 :C34CC9B0:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:29:233] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-08-22 22:00:00.569430 :C34CC9B8:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:29:233] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-08-22 22:00:00.569602 :C34CC9C0:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:29:233] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-08-22 22:00:00.569750 :C34CC9C8:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:29:233] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-08-22 22:00:00.569987 :C34CC9D0:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:29:233] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-08-22 22:00:00.570483 :C34CC9D8:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:29:233] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-08-22 22:00:00.570673 :C34CC9E0:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:29:233] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-08-22 22:00:00.570831 :C34CC9E8:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:29:233] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-08-22 22:00:00.571132 :C34CC9F0:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:29:233] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-08-22 22:00:00.571385 :C34CC9F8:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:29:233] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-08-22 22:00:00.571628 :C34CCA00:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:29:233] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-08-22 22:00:00.572240 :C34CCA08:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:29:233] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-08-22 22:00:00.598582 :C34CCA10:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:29:233] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-08-22 22:00:02.010561*:C34CCCE6:sql_mon_query:keswx.c@6099:keswxCurPushMonitoring(begin): xsc=0x0000000031233AD0 estart=1755871201 eid=21608517 ctx=0x0000000777968158 cwh=0x000000002B460AB8 cpu=0 buffg=2 interb=0 r=0 rb=0 w=0 wb=0 2025-08-22 22:00:02.010561*:C34CCCE7:sql_mon_query:keswx.c@2839:keswxCurPrepare(): Allocate monitor context: xsc=0x0000000031233AD0 curCtx=0x000000005917C4B8 pubTabIdxCnt=0 2025-08-22 22:00:02.010561*:C34CCCE8:sql_mon_query:keswx.c@6131:keswxCurPushMonitoring(): clear monitoring flag for xsc=0x0000000031233AD0 2025-08-22 22:00:02.010561*:C34CCCE9:sql_mon_query:keswx.c@6263:keswxCurPushMonitoring(end): full monitoring not yet started for xsc=0x0000000031233AD0 2025-08-22 22:00:02.010561*:C34CCCEA:sql_mon_query:keswx.c@6099:keswxCurPushMonitoring(begin): xsc=0x000000003126AAF8 estart=1755871200 eid=16777535 ctx=0x000000077B54EAC8 cwh=0x000000002B460608 cpu=1218750 buffg=67548 interb=196608 r=24 rb=196608 w=0 wb=0 2025-08-22 22:00:02.010561*:C34CCCEB:sql_mon_query:keswx.c@2839:keswxCurPrepare(): Allocate monitor context: xsc=0x000000003126AAF8 curCtx=0x0000000058F91240 pubTabIdxCnt=0 2025-08-22 22:00:02.010561*:C34CCCEC:sql_mon_query:keswx.c@6131:keswxCurPushMonitoring(): clear monitoring flag for xsc=0x000000003126AAF8 2025-08-22 22:00:02.010561*:C34CCCED:sql_mon_query:keswx.c@6263:keswxCurPushMonitoring(end): full monitoring not yet started for xsc=0x000000003126AAF8 2025-08-22 22:00:02.010561*:C34CCCEE:sql_mon_query:keswx.c@3282:keswxCurEndPlanMonitoringCb(begin): xsc=0x0000000031233AD0 curCtx=0x000000005917C4B8 xsc->flg4=65792 flags=1 2025-08-22 22:00:02.010561*:C34CCCEF:sql_mon_query:keswx.c@3389:keswxCurEndPlanMonitoringCb(end): monitoring has ended for xsc=0x0000000031233AD0 2025-08-22 22:00:02.244943*:C34CCD43:sql_mon_query:keswx.c@3282:keswxCurEndPlanMonitoringCb(begin): xsc=0x000000003126AAF8 curCtx=0x0000000058F91240 xsc->flg4=65792 flags=2 2025-08-22 22:00:02.244943*:C34CCD44:sql_mon_query:keswx.c@3389:keswxCurEndPlanMonitoringCb(end): monitoring has ended for xsc=0x000000003126AAF8 2025-08-22 22:00:02.256252 :C34CCD45:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:29:233] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-08-22 22:00:02.276600 :C34CCD76:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:29:233] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-08-22 22:00:02.278423 :C34CCD82:db_trace:ktc.c@8711:ktcAutoTxnTrace(): [10441:29:233] atxpus:psdpgi.c:2235 2025-08-22 22:00:02.278606 :C34CCD83:db_trace:ktc.c@8711:ktcAutoTxnTrace(): [10441:29:233] atxpop:psdpgi.c:2235 2025-08-22 22:00:02.279481 :C34CCD86:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:29:233] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-08-22 22:00:02.279570 :C34CCD89:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:29:233] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-08-22 22:00:02.280488 :C34CCD9C:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:29:233] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-08-22 22:00:02.281911 :C34CCDA5:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:29:233] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-08-22 22:00:02.282187 :C34CCDAD:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:29:233] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-08-22 22:00:02.338697*:SQL_Analyze:qksan.c@3402:qksanAnalyzeSql(begin): qksanAnalyzeSql(enter): goal=15 options=16778048 pgadep=0 binds#=0 byPos=0 timeLim=0 timeFired=0 2025-08-22 22:00:02.338697*:SQL_Analyze:qksan.c@936:qksanBindSql(begin): binding for SQL analyze 2025-08-22 22:00:02.338697*:SQL_Analyze:qksan.c@1344:qksanBindSql(end): Done binding: status=0 ret=0 bind#=0 byPos=1 wasBoundP=0x0000000000000000 bindIndP=0x0000000000000000 2025-08-22 22:00:02.338697*:SQL_Analyze:qksan.c@6338:qksanAvgExecStats(): The number of total executions: 1 and execution count: 0 2025-08-22 22:00:02.338697*:SQL_Analyze:qksan.c@4776:qksanPostAnalyzeDump(begin): qksanPostAnalyzeDump(): Dumping analyze context after compilation qksanStatus=SUCCESS ecode=0 2025-08-22 22:00:02.338697*:SQL_Analyze:qksan.c@4800:qksanPostAnalyzeDump(end): 2025-08-22 22:00:02.338697*:SQL_Analyze:qksan.c@3690:qksanAnalyzeSql(end): exit: ecode=0 status=0 2025-08-22 22:00:02.414785 :C34CCE2E:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:29:233] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-08-22 22:00:04.301286 :C34CCF95:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:29:233] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-08-22 22:00:04.301298 :C34CCF96:db_trace:ktur.c@3079:ktuabt(): [10444:29:233] ABORT TRANSACTION - xid: 0x0008.007.0000d257 2025-08-22 22:00:06.745254 :C34CD108:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:29:233] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-08-22 22:00:06.746933 :C34CD110:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:29:233] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-08-22 22:00:06.758479 :C34CD118:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:29:233] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-08-22 22:00:06.788063 :C34CD12C:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:29:233] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-08-22 22:00:07.995238 :C34CD25D:db_trace:ktc.c@8711:ktcAutoTxnTrace(): [10441:29:233] atxpop:jslv.c:9203 2025-08-22 22:00:08.005740 :C34CD25E:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:29:0] KSL POST SENT postee=59 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-08-22 22:00:08.007068 :C34CD266:db_trace:kst.c@698:kstpsodel(): [10280:29:0] kst: process state object about to be deleted ------------------------------------------------------------------------------- Trace Bucket Dump End: default bucket for process 29 (osid: 20016, J003)