Trace file d:\app\administrator\diag\rdbms\orcl\orcl\trace\cdmp_20250601140716\orcl_ora_14064_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:37166M/63366M, Ph+PgF:44019M/72582M Instance name: orcl Redo thread mounted by this instance: 1 Oracle process number: 29 Windows thread id: 14064, image: ORACLE.EXE (SHAD) *** 2025-06-01 14:07:17.031 *** 2025-06-01 14:07:17.031 Process diagnostic dump for ORACLE.EXE (SHAD), OS id=14064, pid: 29, proc_ser: 253, 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-06-01 14:07:17.031 ------------------------------------------------------------------------------- Trace Bucket Dump Begin: default bucket for process 29 (osid: 14064) TIME(*=approx):SEQ:COMPONENT:FILE@LINE:FUNCTION:SECT/DUMP: [EVENT#:PID:SID] DATA ------------------------------------------------------------------------------- 2025-06-01 09:00:30.386836 :9ECEE0C4:db_trace:kso.c@4093:ksonfy(): [10420:29:0] kso: new process: pid=12684 osp_idx=27 osp_ver=11970 osp_pg=0 (spawn #240693) 2025-06-01 09:00:30.386836 :9ECEE0C5:db_trace:kso.c@4099:ksonfy(): [10420:29:0] kso: new process: first_req_pid=3704 spawner_pid=3660 sga_crt_ts=x8A8A 2025-06-01 09:00:30.386837 :9ECEE0C6:db_trace:kso.c@4103:ksonfy(): [10420:29:0] kso: new process: pso_index=29 reservation=187 time=1744189016 2025-06-01 09:00:30.386838 :9ECEE0C7:db_trace:kso.c@4109:ksonfy(): [10420:29:0] kso: spawn diagnostics: queue time=0 secs 2025-06-01 09:00:30.386838 :9ECEE0C8:db_trace:kso.c@4111:ksonfy(): [10420:29:0] kso: spawn diagnostics: fork time=0 secs 2025-06-01 09:00:30.386838 :9ECEE0C9:db_trace:kso.c@4113:ksonfy(): [10420:29:0] kso: spawn diagnostics: exec time=0 secs 2025-06-01 09:00:30.386839 :9ECEE0CA:db_trace:kso.c@4115:ksonfy(): [10420:29:0] kso: spawn diagnostics: pre dbkc time=0 secs 2025-06-01 09:00:30.386839 :9ECEE0CB:db_trace:kso.c@4117:ksonfy(): [10420:29:0] kso: spawn diagnostics: post dbkc time=0 secs 2025-06-01 09:00:30.387331 :9ECEE0CC: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-06-01 09:00:30.387373 :9ECEE0D2: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-06-01 09:00:30.394842 :9ECEE0E0: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-06-01 09:00:30.395947 :9ECEE0E8: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-06-01 09:00:30.396547 :9ECEE0F0: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-06-01 09:00:30.397037 :9ECEE0F8: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-06-01 09:00:30.397487 :9ECEE100: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-06-01 09:00:30.400009 :9ECEE108: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-06-01 09:00:30.401246 :9ECEE110: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-06-01 09:00:30.472032 :9ECEE118: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-06-01 09:00:30.472989 :9ECEE120: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-06-01 09:00:30.473246 :9ECEE128: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-06-01 09:00:30.473467 :9ECEE130: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-06-01 09:00:30.475320 :9ECEE138:db_trace:kst.c@698:kstpsodel(): [10280:29:0] kst: process state object about to be deleted 2025-06-01 10:00:38.536221 :9ED39911:db_trace:kst.c@673:kstipg(): [10280:29:0] kst: process state object created on 06-01 10:00:38.526 2025-06-01 10:00:38.536224 :9ED39912:db_trace:kst.c@679:kstipg(): [10280:29:0] kst: process info: ospid=14204 pso_num=29 pso_serial#=242 2025-06-01 10:00:38.536361 :9ED39913:db_trace:kso.c@4093:ksonfy(): [10420:29:0] kso: new process: pid=14204 osp_idx=27 osp_ver=11971 osp_pg=0 (spawn #240829) 2025-06-01 10:00:38.536362 :9ED39914:db_trace:kso.c@4099:ksonfy(): [10420:29:0] kso: new process: first_req_pid=3704 spawner_pid=3660 sga_crt_ts=x8A8A 2025-06-01 10:00:38.536362 :9ED39915:db_trace:kso.c@4103:ksonfy(): [10420:29:0] kso: new process: pso_index=29 reservation=188 time=1747797172 2025-06-01 10:00:38.536363 :9ED39916:db_trace:kso.c@4109:ksonfy(): [10420:29:0] kso: spawn diagnostics: queue time=0 secs 2025-06-01 10:00:38.536363 :9ED39917:db_trace:kso.c@4111:ksonfy(): [10420:29:0] kso: spawn diagnostics: fork time=0 secs 2025-06-01 10:00:38.536364 :9ED39918:db_trace:kso.c@4113:ksonfy(): [10420:29:0] kso: spawn diagnostics: exec time=0 secs 2025-06-01 10:00:38.536364 :9ED39919:db_trace:kso.c@4115:ksonfy(): [10420:29:0] kso: spawn diagnostics: pre dbkc time=0 secs 2025-06-01 10:00:38.536364 :9ED3991A:db_trace:kso.c@4117:ksonfy(): [10420:29:0] kso: spawn diagnostics: post dbkc time=0 secs 2025-06-01 10:00:38.536869 :9ED3991B: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-06-01 10:00:38.536915 :9ED39921: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-06-01 10:00:38.544764 :9ED3992F: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-06-01 10:00:38.545855 :9ED39937: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-06-01 10:00:38.546412 :9ED3993F: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-06-01 10:00:38.546869 :9ED39947: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-06-01 10:00:38.547296 :9ED3994F: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-06-01 10:00:38.549783 :9ED39957: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-06-01 10:00:38.550870 :9ED3995F: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-06-01 10:00:38.601854 :9ED39967: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-06-01 10:00:38.602734 :9ED3996F: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-06-01 10:00:38.602976 :9ED39977: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-06-01 10:00:38.603190 :9ED3997F: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-06-01 10:00:38.604982 :9ED39987:db_trace:kst.c@698:kstpsodel(): [10280:29:0] kst: process state object about to be deleted 2025-06-01 11:00:46.312724 :9ED845F2:db_trace:kst.c@673:kstipg(): [10280:29:0] kst: process state object created on 06-01 11:00:46.310 2025-06-01 11:00:46.312726 :9ED845F3:db_trace:kst.c@679:kstipg(): [10280:29:0] kst: process info: ospid=12644 pso_num=29 pso_serial#=243 2025-06-01 11:00:46.312862 :9ED845F4:db_trace:kso.c@4093:ksonfy(): [10420:29:0] kso: new process: pid=12644 osp_idx=27 osp_ver=11972 osp_pg=0 (spawn #240968) 2025-06-01 11:00:46.312863 :9ED845F5:db_trace:kso.c@4099:ksonfy(): [10420:29:0] kso: new process: first_req_pid=3704 spawner_pid=3660 sga_crt_ts=x8A8A 2025-06-01 11:00:46.312863 :9ED845F6:db_trace:kso.c@4103:ksonfy(): [10420:29:0] kso: new process: pso_index=29 reservation=189 time=1751404954 2025-06-01 11:00:46.312864 :9ED845F7:db_trace:kso.c@4109:ksonfy(): [10420:29:0] kso: spawn diagnostics: queue time=0 secs 2025-06-01 11:00:46.312864 :9ED845F8:db_trace:kso.c@4111:ksonfy(): [10420:29:0] kso: spawn diagnostics: fork time=0 secs 2025-06-01 11:00:46.312864 :9ED845F9:db_trace:kso.c@4113:ksonfy(): [10420:29:0] kso: spawn diagnostics: exec time=0 secs 2025-06-01 11:00:46.312865 :9ED845FA:db_trace:kso.c@4115:ksonfy(): [10420:29:0] kso: spawn diagnostics: pre dbkc time=0 secs 2025-06-01 11:00:46.312865 :9ED845FB:db_trace:kso.c@4117:ksonfy(): [10420:29:0] kso: spawn diagnostics: post dbkc time=0 secs 2025-06-01 11:00:46.313348 :9ED845FC: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-06-01 11:00:46.313405 :9ED84602: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-06-01 11:00:46.320613 :9ED84610: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-06-01 11:00:46.321678 :9ED84618: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-06-01 11:00:46.322323 :9ED84620: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-06-01 11:00:46.322820 :9ED84628: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-06-01 11:00:46.323275 :9ED84630: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-06-01 11:00:46.325755 :9ED84638: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-06-01 11:00:46.326958 :9ED8464B: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-06-01 11:00:46.377806 :9ED84653: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-06-01 11:00:46.378663 :9ED8465B: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-06-01 11:00:46.378895 :9ED84663: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-06-01 11:00:46.379111 :9ED8466B: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-06-01 11:00:46.380845 :9ED84673:db_trace:kst.c@698:kstpsodel(): [10280:29:0] kst: process state object about to be deleted 2025-06-01 12:00:53.365493 :9EDCEB84:db_trace:kst.c@673:kstipg(): [10280:29:0] kst: process state object created on 06-01 12:00:53.352 2025-06-01 12:00:53.365495 :9EDCEB85:db_trace:kst.c@679:kstipg(): [10280:29:0] kst: process info: ospid=15264 pso_num=29 pso_serial#=244 2025-06-01 12:00:53.365638 :9EDCEB86:db_trace:kso.c@4070:ksonfy(): [10420:29:0] kso: new process: pid=15264 (legacy spawn) 2025-06-01 12:00:53.372088 :9EDCEB87: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-06-01 12:00:53.372471 :9EDCEB8C: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-06-01 12:00:53.373313 :9EDCEB91:db_trace:kst.c@698:kstpsodel(): [10280:29:0] kst: process state object about to be deleted 2025-06-01 12:00:53.381805 :9EDCEB94:db_trace:kst.c@673:kstipg(): [10280:29:0] kst: process state object created on 06-01 12:00:53.368 2025-06-01 12:00:53.381806 :9EDCEB95:db_trace:kst.c@679:kstipg(): [10280:29:0] kst: process info: ospid=13168 pso_num=29 pso_serial#=245 2025-06-01 12:00:53.381944 :9EDCEB96:db_trace:kso.c@4070:ksonfy(): [10420:29:0] kso: new process: pid=13168 (legacy spawn) 2025-06-01 12:00:53.388314 :9EDCEBA2: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-06-01 12:00:53.388479 :9EDCEBAB: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-06-01 12:00:53.389267 :9EDCEBAC:db_trace:kst.c@698:kstpsodel(): [10280:29:0] kst: process state object about to be deleted 2025-06-01 12:00:54.024202 :9EDCEBF7:db_trace:kst.c@673:kstipg(): [10280:29:0] kst: process state object created on 06-01 12:00:54.024 2025-06-01 12:00:54.024204 :9EDCEBF8:db_trace:kst.c@679:kstipg(): [10280:29:0] kst: process info: ospid=11456 pso_num=29 pso_serial#=246 2025-06-01 12:00:54.024337 :9EDCEBF9:db_trace:kso.c@4093:ksonfy(): [10420:29:0] kso: new process: pid=11456 osp_idx=27 osp_ver=11975 osp_pg=0 (spawn #241104) 2025-06-01 12:00:54.024338 :9EDCEBFA:db_trace:kso.c@4099:ksonfy(): [10420:29:0] kso: new process: first_req_pid=3704 spawner_pid=3660 sga_crt_ts=x8A8A 2025-06-01 12:00:54.024338 :9EDCEBFB:db_trace:kso.c@4103:ksonfy(): [10420:29:0] kso: new process: pso_index=29 reservation=190 time=1755012657 2025-06-01 12:00:54.024338 :9EDCEBFC:db_trace:kso.c@4109:ksonfy(): [10420:29:0] kso: spawn diagnostics: queue time=0 secs 2025-06-01 12:00:54.024339 :9EDCEBFD:db_trace:kso.c@4111:ksonfy(): [10420:29:0] kso: spawn diagnostics: fork time=0 secs 2025-06-01 12:00:54.024339 :9EDCEBFE:db_trace:kso.c@4113:ksonfy(): [10420:29:0] kso: spawn diagnostics: exec time=0 secs 2025-06-01 12:00:54.024339 :9EDCEBFF:db_trace:kso.c@4115:ksonfy(): [10420:29:0] kso: spawn diagnostics: pre dbkc time=0 secs 2025-06-01 12:00:54.024340 :9EDCEC00:db_trace:kso.c@4117:ksonfy(): [10420:29:0] kso: spawn diagnostics: post dbkc time=0 secs 2025-06-01 12:00:54.024842 :9EDCEC01: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-06-01 12:00:54.024885 :9EDCEC07: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-06-01 12:00:54.032759 :9EDCEC15: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-06-01 12:00:54.033843 :9EDCEC1D: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-06-01 12:00:54.034398 :9EDCEC25: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-06-01 12:00:54.034848 :9EDCEC2D: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-06-01 12:00:54.035359 :9EDCEC35: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-06-01 12:00:54.037800 :9EDCEC3D: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-06-01 12:00:54.038847 :9EDCEC45: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-06-01 12:00:54.089178 :9EDCEC4D: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-06-01 12:00:54.090080 :9EDCEC55: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-06-01 12:00:54.090322 :9EDCEC5D: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-06-01 12:00:54.090532 :9EDCEC65: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-06-01 12:00:54.092284 :9EDCEC6D:db_trace:kst.c@698:kstpsodel(): [10280:29:0] kst: process state object about to be deleted 2025-06-01 13:00:01.011779 :9EE1860A:db_trace:kst.c@673:kstipg(): [10280:29:0] kst: process state object created on 06-01 13:00:01.006 2025-06-01 13:00:01.011781 :9EE1860B:db_trace:kst.c@679:kstipg(): [10280:29:0] kst: process info: ospid=12796 pso_num=29 pso_serial#=247 2025-06-01 13:00:01.011930 :9EE1860C:db_trace:kso.c@4093:ksonfy(): [10420:29:0] kso: new process: pid=12796 osp_idx=27 osp_ver=11976 osp_pg=0 (spawn #241239) 2025-06-01 13:00:01.011931 :9EE1860D:db_trace:kso.c@4099:ksonfy(): [10420:29:0] kso: new process: first_req_pid=3704 spawner_pid=3660 sga_crt_ts=x8A8A 2025-06-01 13:00:01.011932 :9EE1860E:db_trace:kso.c@4103:ksonfy(): [10420:29:0] kso: new process: pso_index=29 reservation=191 time=1758559657 2025-06-01 13:00:01.011932 :9EE1860F:db_trace:kso.c@4109:ksonfy(): [10420:29:0] kso: spawn diagnostics: queue time=0 secs 2025-06-01 13:00:01.011933 :9EE18610:db_trace:kso.c@4111:ksonfy(): [10420:29:0] kso: spawn diagnostics: fork time=0 secs 2025-06-01 13:00:01.011933 :9EE18611:db_trace:kso.c@4113:ksonfy(): [10420:29:0] kso: spawn diagnostics: exec time=0 secs 2025-06-01 13:00:01.011934 :9EE18612:db_trace:kso.c@4115:ksonfy(): [10420:29:0] kso: spawn diagnostics: pre dbkc time=0 secs 2025-06-01 13:00:01.011934 :9EE18613:db_trace:kso.c@4117:ksonfy(): [10420:29:0] kso: spawn diagnostics: post dbkc time=0 secs 2025-06-01 13:00:01.012511 :9EE18614: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-06-01 13:00:01.012578 :9EE1861A: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-06-01 13:00:01.017178 :9EE1862D: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-06-01 13:00:01.042073 :9EE18635:db_trace:ksb.c@6610:ksbcic_int(): [10254:29:233] KSBCIC: (USER) starting cic on opcode KSBCIRCO [1] with args (1 4286464372 8502928) 2025-06-01 13:00:01.042079 :9EE18636:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:29:233] KSL POST SENT postee=15 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-01 13:00:01.042126 :9EE1863E:db_trace:ksl2.c@12699:ksliwat(): [10005:29:233] KSL POST RCVD poster=15 loc='ksa2.h LINE:286 ID:ksasnr' id1=0 id2=0 name= type=0 fac#=0 facpost=1 2025-06-01 13:00:01.042170 :9EE1864E: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-06-01 13:00:01.056803 :9EE18656: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-06-01 13:00:01.084785 :9EE1865E: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-06-01 13:00:01.088566 :9EE18666: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-06-01 13:00:01.092243 :9EE1866E: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-06-01 13:00:01.096372 :9EE18676: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-06-01 13:00:01.097452 :9EE1867E: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-06-01 13:00:01.101395 :9EE18686:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:29:233] KSL POST SENT postee=16 loc='ktm.h LINE:583 ID:ktmpsm' id1=0 id2=0 name= type=0 2025-06-01 13:00:01.101576 :9EE18694:db_trace:ksl2.c@12699:ksliwat(): [10005:29:233] KSL POST RCVD poster=16 loc='kcb2.h LINE:3844 ID:kcbzww' id1=0 id2=0 name= type=0 fac#=0 facpost=1 2025-06-01 13:00:02.089126*:9EE1873D:sql_mon_query:keswx.c@6099:keswxCurPushMonitoring(begin): xsc=0x000000002B568200 estart=1748754001 eid=16778907 ctx=0x000000077BA4B1C8 cwh=0x000000002B520828 cpu=359375 buffg=0 interb=0 r=0 rb=0 w=0 wb=0 2025-06-01 13:00:02.089126*:9EE1873E:sql_mon_query:keswx.c@2839:keswxCurPrepare(): Allocate monitor context: xsc=0x000000002B568200 curCtx=0x000000002DB4C2C0 pubTabIdxCnt=0 2025-06-01 13:00:02.089126*:9EE1873F:sql_mon_query:keswx.c@6131:keswxCurPushMonitoring(): clear monitoring flag for xsc=0x000000002B568200 2025-06-01 13:00:02.089126*:9EE18740:sql_mon_query:keswx.c@6263:keswxCurPushMonitoring(end): full monitoring not yet started for xsc=0x000000002B568200 2025-06-01 13:00:02.089126*:9EE18741:sql_mon_query:keswx.c@6099:keswxCurPushMonitoring(begin): xsc=0x000000002B565810 estart=1748754001 eid=16778897 ctx=0x0000000787AD5BF0 cwh=0x000000002B520AF8 cpu=359375 buffg=0 interb=0 r=0 rb=0 w=0 wb=0 2025-06-01 13:00:02.089126*:9EE18742:sql_mon_query:keswx.c@2839:keswxCurPrepare(): Allocate monitor context: xsc=0x000000002B565810 curCtx=0x000000002DB4F780 pubTabIdxCnt=0 2025-06-01 13:00:02.089126*:9EE18743:sql_mon_query:keswx.c@6131:keswxCurPushMonitoring(): clear monitoring flag for xsc=0x000000002B565810 2025-06-01 13:00:02.089126*:9EE18744:sql_mon_query:keswx.c@6263:keswxCurPushMonitoring(end): full monitoring not yet started for xsc=0x000000002B565810 2025-06-01 13:00:02.276638*:9EE18745:sql_mon_query:keswx.c@3282:keswxCurEndPlanMonitoringCb(begin): xsc=0x000000002B568200 curCtx=0x000000002DB4C2C0 xsc->flg4=65792 flags=1 2025-06-01 13:00:02.276638*:9EE18746:sql_mon_query:keswx.c@3389:keswxCurEndPlanMonitoringCb(end): monitoring has ended for xsc=0x000000002B568200 2025-06-01 13:00:02.276638*:9EE18747:sql_mon_query:keswx.c@3282:keswxCurEndPlanMonitoringCb(begin): xsc=0x000000002B565810 curCtx=0x000000002DB4F780 xsc->flg4=65792 flags=2 2025-06-01 13:00:02.276638*:9EE18748:sql_mon_query:keswx.c@3389:keswxCurEndPlanMonitoringCb(end): monitoring has ended for xsc=0x000000002B565810 2025-06-01 13:00:02.351457 :9EE18749: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-06-01 13:00:02.384369 :9EE18751: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-06-01 13:00:02.384732 :9EE18759: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-06-01 13:00:02.385075 :9EE18761: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-06-01 13:00:02.385091 :9EE18764: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-06-01 13:00:02.385158 :9EE18770: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-06-01 13:00:02.390024 :9EE1877E:db_trace:kst.c@698:kstpsodel(): [10280:29:0] kst: process state object about to be deleted 2025-06-01 13:00:16.876987 :9EE18D7E:db_trace:kst.c@673:kstipg(): [10280:29:0] kst: process state object created on 06-01 13:00:16.874 2025-06-01 13:00:16.876989 :9EE18D7F:db_trace:kst.c@679:kstipg(): [10280:29:0] kst: process info: ospid=15100 pso_num=29 pso_serial#=248 2025-06-01 13:00:16.877125 :9EE18D80:db_trace:kso.c@4070:ksonfy(): [10420:29:0] kso: new process: pid=15100 (legacy spawn) 2025-06-01 13:00:16.883589 :9EE18D81: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-06-01 13:00:16.883756 :9EE18D87: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-06-01 13:00:16.884559 :9EE18D8B:db_trace:kst.c@698:kstpsodel(): [10280:29:0] kst: process state object about to be deleted 2025-06-01 13:00:16.913716 :9EE18D8E:db_trace:kst.c@673:kstipg(): [10280:29:0] kst: process state object created on 06-01 13:00:16.905 2025-06-01 13:00:16.913718 :9EE18D8F:db_trace:kst.c@679:kstipg(): [10280:29:0] kst: process info: ospid=8432 pso_num=29 pso_serial#=249 2025-06-01 13:00:16.913858 :9EE18D90:db_trace:kso.c@4070:ksonfy(): [10420:29:0] kso: new process: pid=8432 (legacy spawn) 2025-06-01 13:00:16.920333 :9EE18D91: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-06-01 13:00:16.920519 :9EE18D9A: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-06-01 13:00:16.921300 :9EE18D9B:db_trace:kst.c@698:kstpsodel(): [10280:29:0] kst: process state object about to be deleted 2025-06-01 13:00:20.225009 :9EE18EAB:db_trace:kst.c@673:kstipg(): [10280:29:0] kst: process state object created on 06-01 13:00:20.212 2025-06-01 13:00:20.225011 :9EE18EAC:db_trace:kst.c@679:kstipg(): [10280:29:0] kst: process info: ospid=14548 pso_num=29 pso_serial#=250 2025-06-01 13:00:20.225155 :9EE18EAD:db_trace:kso.c@4070:ksonfy(): [10420:29:0] kso: new process: pid=14548 (legacy spawn) 2025-06-01 13:00:20.231729 :9EE18EAE: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-06-01 13:00:20.231901 :9EE18EB3: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-06-01 13:00:20.232702 :9EE18EB8:db_trace:kst.c@698:kstpsodel(): [10280:29:0] kst: process state object about to be deleted 2025-06-01 13:00:20.241175 :9EE18EBB:db_trace:kst.c@673:kstipg(): [10280:29:0] kst: process state object created on 06-01 13:00:20.228 2025-06-01 13:00:20.241177 :9EE18EBC:db_trace:kst.c@679:kstipg(): [10280:29:0] kst: process info: ospid=3448 pso_num=29 pso_serial#=251 2025-06-01 13:00:20.241313 :9EE18EBD:db_trace:kso.c@4070:ksonfy(): [10420:29:0] kso: new process: pid=3448 (legacy spawn) 2025-06-01 13:00:20.247891 :9EE18EBE: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-06-01 13:00:20.248054 :9EE18EC7: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-06-01 13:00:20.248827 :9EE18EC8:db_trace:kst.c@698:kstpsodel(): [10280:29:0] kst: process state object about to be deleted 2025-06-01 13:00:27.027350 :9EE190A9:db_trace:kst.c@673:kstipg(): [10280:29:0] kst: process state object created on 06-01 13:00:27.014 2025-06-01 13:00:27.027352 :9EE190AA:db_trace:kst.c@679:kstipg(): [10280:29:0] kst: process info: ospid=14876 pso_num=29 pso_serial#=252 2025-06-01 13:00:27.027494 :9EE190AB:db_trace:kso.c@4070:ksonfy(): [10420:29:0] kso: new process: pid=14876 (legacy spawn) 2025-06-01 13:00:27.034242 :9EE190AC: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-06-01 13:00:27.034412 :9EE190B1: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-06-01 13:00:27.035227 :9EE190B6:db_trace:kst.c@698:kstpsodel(): [10280:29:0] kst: process state object about to be deleted 2025-06-01 13:00:27.037320 :9EE190B9:db_trace:kst.c@673:kstipg(): [10280:29:0] kst: process state object created on 06-01 13:00:27.030 2025-06-01 13:00:27.037321 :9EE190BA:db_trace:kst.c@679:kstipg(): [10280:29:0] kst: process info: ospid=14064 pso_num=29 pso_serial#=253 2025-06-01 13:00:27.037442 :9EE190BB:db_trace:kso.c@4070:ksonfy(): [10420:29:0] kso: new process: pid=14064 (legacy spawn) 2025-06-01 13:00:27.043888 :9EE190BC: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-06-01 13:00:27.044045 :9EE190C5: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-06-01 13:00:27.044876 :9EE190C6: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: 14064)