Edit D:\app\Administrator\diag\rdbms\orcl\orcl\trace\cdmp_20250628060009\orcl_j001_11192_bucket.trc
Trace file d:\app\administrator\diag\rdbms\orcl\orcl\trace\cdmp_20250628060009\orcl_j001_11192_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:36357M/63366M, Ph+PgF:42457M/72582M Instance name: orcl Redo thread mounted by this instance: 1 Oracle process number: 26 Windows thread id: 11192, image: ORACLE.EXE (J001) *** 2025-06-28 06:00:09.418 *** SESSION ID:(209.7059) 2025-06-28 06:00:09.418 *** 2025-06-28 06:00:09.418 Process diagnostic dump for ORACLE.EXE (J001), OS id=11192, pid: 26, proc_ser: 189, sid: 209, sess_ser: 7059 ------------------------------------------------------------------------------- current sql: <none> client details: O/S info: user: SYSTEM, term: WIN-3PIMCL4OH3L, ospid: 11192 machine: WIN-3PIMCL4OH3L program: ORACLE.EXE (J001) Current Wait Stack: 0: waiting for 'jobq slave wait' =0x0, =0x0, =0x0 wait_id=9 seq_num=10 snap_id=1 wait times: snap=0.417810 sec, exc=0.417810 sec, total=0.417810 sec wait times: max=0.500000 sec, heur=4.916957 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.000009 sec since current wait 0: waited for 'jobq slave wait' =0x0, =0x0, =0x0 wait_id=8 seq_num=9 snap_id=1 wait times: snap=0.505098 sec, exc=0.505098 sec, total=0.505098 sec wait times: max=0.500000 sec wait counts: calls=1 os=1 occurred after 0.000014 sec of elapsed time 1: waited for 'jobq slave wait' =0x0, =0x0, =0x0 wait_id=7 seq_num=8 snap_id=1 wait times: snap=0.500000 sec, exc=0.500000 sec, total=0.500000 sec wait times: max=0.500000 sec wait counts: calls=1 os=1 occurred after 0.000010 sec of elapsed time 2: waited for 'jobq slave wait' =0x0, =0x0, =0x0 wait_id=6 seq_num=7 snap_id=1 wait times: snap=0.499996 sec, exc=0.499996 sec, total=0.499996 sec wait times: max=0.500000 sec wait counts: calls=1 os=1 occurred after 0.000010 sec of elapsed time 3: waited for 'jobq slave wait' =0x0, =0x0, =0x0 wait_id=5 seq_num=6 snap_id=1 wait times: snap=0.499999 sec, exc=0.499999 sec, total=0.499999 sec wait times: max=0.500000 sec wait counts: calls=1 os=1 occurred after 0.000009 sec of elapsed time 4: waited for 'jobq slave wait' =0x0, =0x0, =0x0 wait_id=4 seq_num=5 snap_id=1 wait times: snap=0.500001 sec, exc=0.500001 sec, total=0.500001 sec wait times: max=0.500000 sec wait counts: calls=1 os=1 occurred after 0.000008 sec of elapsed time 5: waited for 'jobq slave wait' =0x0, =0x0, =0x0 wait_id=3 seq_num=4 snap_id=1 wait times: snap=0.499994 sec, exc=0.499994 sec, total=0.499994 sec wait times: max=0.500000 sec wait counts: calls=1 os=1 occurred after 0.000010 sec of elapsed time 6: waited for 'jobq slave wait' =0x0, =0x0, =0x0 wait_id=2 seq_num=3 snap_id=1 wait times: snap=0.503170 sec, exc=0.503170 sec, total=0.503170 sec wait times: max=0.500000 sec wait counts: calls=1 os=1 occurred after 0.000015 sec of elapsed time 7: waited for 'jobq slave wait' =0x0, =0x0, =0x0 wait_id=1 seq_num=2 snap_id=1 wait times: snap=0.499990 sec, exc=0.499990 sec, total=0.499990 sec wait times: max=0.500000 sec wait counts: calls=1 os=1 occurred after 0.000014 sec of elapsed time 8: waited for 'jobq slave wait' =0x0, =0x0, =0x0 wait_id=0 seq_num=1 snap_id=1 wait times: snap=0.490800 sec, exc=0.490800 sec, total=0.490800 sec wait times: max=0.500000 sec wait counts: calls=1 os=1 occurred after 0.000000 sec of elapsed time Sampled Session History of session 209 serial 7059 --------------------------------------------------- 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 --------------------------------------------------- [5 samples, 06:00:04 - 06:00:09] idle wait at each sample [session created at: 06:00:04] ------------------------------------------------------------------------------- Process diagnostic dump actual duration=0.000000 sec (max dump time=30.000000 sec) *** 2025-06-28 06:00:09.418 ------------------------------------------------------------------------------- Trace Bucket Dump Begin: default bucket for process 26 (osid: 11192, J001) TIME(*=approx):SEQ:COMPONENT:FILE@LINE:FUNCTION:SECT/DUMP: [EVENT#:PID:SID] DATA ------------------------------------------------------------------------------- 2025-06-28 05:57:50.140805 :AAA4A05D:db_trace:kst.c@698:kstpsodel(): [10280:26:0] kst: process state object about to be deleted 2025-06-28 05:57:53.313655 :AAA4A165:db_trace:kst.c@673:kstipg(): [10280:26:0] kst: process state object created on 06-28 05:57:53.312 2025-06-28 05:57:53.313657 :AAA4A166:db_trace:kst.c@679:kstipg(): [10280:26:0] kst: process info: ospid=18264 pso_num=26 pso_serial#=173 2025-06-28 05:57:53.313789 :AAA4A167:db_trace:kso.c@4070:ksonfy(): [10420:26:0] kso: new process: pid=18264 (legacy spawn) 2025-06-28 05:57:53.320227 :AAA4A168:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:26:209] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-28 05:57:53.320393 :AAA4A16D:db_trace:ksl2.c@12699:ksliwat(): [10005:26:209] 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-28 05:57:53.321196 :AAA4A172:db_trace:kst.c@698:kstpsodel(): [10280:26:0] kst: process state object about to be deleted 2025-06-28 05:57:53.329926 :AAA4A175:db_trace:kst.c@673:kstipg(): [10280:26:0] kst: process state object created on 06-28 05:57:53.327 2025-06-28 05:57:53.329929 :AAA4A176:db_trace:kst.c@679:kstipg(): [10280:26:0] kst: process info: ospid=4932 pso_num=26 pso_serial#=174 2025-06-28 05:57:53.330065 :AAA4A177:db_trace:kso.c@4070:ksonfy(): [10420:26:0] kso: new process: pid=4932 (legacy spawn) 2025-06-28 05:57:53.336496 :AAA4A178:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:26:209] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-28 05:57:53.336684 :AAA4A181:db_trace:ksl2.c@12699:ksliwat(): [10005:26:209] 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-28 05:57:53.337545 :AAA4A182:db_trace:kst.c@698:kstpsodel(): [10280:26:0] kst: process state object about to be deleted 2025-06-28 05:58:26.543519 :AAA4AC35:db_trace:kst.c@673:kstipg(): [10280:26:0] kst: process state object created on 06-28 05:58:26.535 2025-06-28 05:58:26.543522 :AAA4AC36:db_trace:kst.c@679:kstipg(): [10280:26:0] kst: process info: ospid=18004 pso_num=26 pso_serial#=175 2025-06-28 05:58:26.543657 :AAA4AC37:db_trace:kso.c@4070:ksonfy(): [10420:26:0] kso: new process: pid=18004 (legacy spawn) 2025-06-28 05:58:26.550149 :AAA4AC38:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:26:209] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-28 05:58:26.550322 :AAA4AC3D:db_trace:ksl2.c@12699:ksliwat(): [10005:26:209] 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-28 05:58:26.551128 :AAA4AC42:db_trace:kst.c@698:kstpsodel(): [10280:26:0] kst: process state object about to be deleted 2025-06-28 05:58:26.559804 :AAA4AC45:db_trace:kst.c@673:kstipg(): [10280:26:0] kst: process state object created on 06-28 05:58:26.551 2025-06-28 05:58:26.559806 :AAA4AC46:db_trace:kst.c@679:kstipg(): [10280:26:0] kst: process info: ospid=2268 pso_num=26 pso_serial#=176 2025-06-28 05:58:26.559940 :AAA4AC47:db_trace:kso.c@4070:ksonfy(): [10420:26:0] kso: new process: pid=2268 (legacy spawn) 2025-06-28 05:58:26.566324 :AAA4AC48:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:26:209] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-28 05:58:26.566484 :AAA4AC50:db_trace:ksl2.c@12699:ksliwat(): [10005:26:209] 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-28 05:58:26.567273 :AAA4AC51:db_trace:kst.c@698:kstpsodel(): [10280:26:0] kst: process state object about to be deleted 2025-06-28 05:58:29.616122 :AAA4AD36:db_trace:kst.c@673:kstipg(): [10280:26:0] kst: process state object created on 06-28 05:58:29.602 2025-06-28 05:58:29.616124 :AAA4AD37:db_trace:kst.c@679:kstipg(): [10280:26:0] kst: process info: ospid=15664 pso_num=26 pso_serial#=177 2025-06-28 05:58:29.616269 :AAA4AD38:db_trace:kso.c@4070:ksonfy(): [10420:26:0] kso: new process: pid=15664 (legacy spawn) 2025-06-28 05:58:29.623040 :AAA4AD39:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:26:209] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-28 05:58:29.623208 :AAA4AD3E:db_trace:ksl2.c@12699:ksliwat(): [10005:26:209] 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-28 05:58:29.624066 :AAA4AD43:db_trace:kst.c@698:kstpsodel(): [10280:26:0] kst: process state object about to be deleted 2025-06-28 05:58:29.633103 :AAA4AD46:db_trace:kst.c@673:kstipg(): [10280:26:0] kst: process state object created on 06-28 05:58:29.618 2025-06-28 05:58:29.633105 :AAA4AD47:db_trace:kst.c@679:kstipg(): [10280:26:0] kst: process info: ospid=10676 pso_num=26 pso_serial#=178 2025-06-28 05:58:29.633250 :AAA4AD48:db_trace:kso.c@4070:ksonfy(): [10420:26:0] kso: new process: pid=10676 (legacy spawn) 2025-06-28 05:58:29.640111 :AAA4AD49:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:26:209] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-28 05:58:29.640279 :AAA4AD52:db_trace:ksl2.c@12699:ksliwat(): [10005:26:209] 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-28 05:58:29.641142 :AAA4AD53:db_trace:kst.c@698:kstpsodel(): [10280:26:0] kst: process state object about to be deleted 2025-06-28 05:58:45.188970 :AAA4B230:db_trace:kst.c@673:kstipg(): [10280:26:0] kst: process state object created on 06-28 05:58:45.176 2025-06-28 05:58:45.188972 :AAA4B231:db_trace:kst.c@679:kstipg(): [10280:26:0] kst: process info: ospid=16104 pso_num=26 pso_serial#=179 2025-06-28 05:58:45.189102 :AAA4B232:db_trace:kso.c@4070:ksonfy(): [10420:26:0] kso: new process: pid=16104 (legacy spawn) 2025-06-28 05:58:45.195611 :AAA4B233:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:26:209] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-28 05:58:45.195792 :AAA4B238:db_trace:ksl2.c@12699:ksliwat(): [10005:26:209] 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-28 05:58:45.196583 :AAA4B23D:db_trace:kst.c@698:kstpsodel(): [10280:26:0] kst: process state object about to be deleted 2025-06-28 05:58:49.547679 :AAA4B395:db_trace:kst.c@673:kstipg(): [10280:26:0] kst: process state object created on 06-28 05:58:49.539 2025-06-28 05:58:49.547681 :AAA4B396:db_trace:kst.c@679:kstipg(): [10280:26:0] kst: process info: ospid=17004 pso_num=26 pso_serial#=180 2025-06-28 05:58:49.547822 :AAA4B397:db_trace:kso.c@4070:ksonfy(): [10420:26:0] kso: new process: pid=17004 (legacy spawn) 2025-06-28 05:58:49.554388 :AAA4B398:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:26:209] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-28 05:58:49.554561 :AAA4B3A0:db_trace:ksl2.c@12699:ksliwat(): [10005:26:209] 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-28 05:58:49.555395 :AAA4B3A2:db_trace:kst.c@698:kstpsodel(): [10280:26:0] kst: process state object about to be deleted 2025-06-28 05:59:28.502721 :AAA4C0A5:db_trace:kst.c@673:kstipg(): [10280:26:0] kst: process state object created on 06-28 05:59:28.489 2025-06-28 05:59:28.502723 :AAA4C0A6:db_trace:kst.c@679:kstipg(): [10280:26:0] kst: process info: ospid=11628 pso_num=26 pso_serial#=181 2025-06-28 05:59:28.502861 :AAA4C0A7:db_trace:kso.c@4070:ksonfy(): [10420:26:0] kso: new process: pid=11628 (legacy spawn) 2025-06-28 05:59:28.509280 :AAA4C0A8:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:26:209] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-28 05:59:28.509459 :AAA4C0AD:db_trace:ksl2.c@12699:ksliwat(): [10005:26:209] 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-28 05:59:28.510268 :AAA4C0B1:db_trace:kst.c@698:kstpsodel(): [10280:26:0] kst: process state object about to be deleted 2025-06-28 05:59:28.518923 :AAA4C0B4:db_trace:kst.c@673:kstipg(): [10280:26:0] kst: process state object created on 06-28 05:59:28.505 2025-06-28 05:59:28.518925 :AAA4C0B5:db_trace:kst.c@679:kstipg(): [10280:26:0] kst: process info: ospid=15912 pso_num=26 pso_serial#=182 2025-06-28 05:59:28.519058 :AAA4C0B6:db_trace:kso.c@4070:ksonfy(): [10420:26:0] kso: new process: pid=15912 (legacy spawn) 2025-06-28 05:59:28.525613 :AAA4C0B7:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:26:209] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-28 05:59:28.525781 :AAA4C0C0:db_trace:ksl2.c@12699:ksliwat(): [10005:26:209] 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-28 05:59:28.526658 :AAA4C0C1:db_trace:kst.c@698:kstpsodel(): [10280:26:0] kst: process state object about to be deleted 2025-06-28 05:59:39.192357 :AAA4C3FB:db_trace:kst.c@673:kstipg(): [10280:26:0] kst: process state object created on 06-28 05:59:39.178 2025-06-28 05:59:39.192359 :AAA4C3FC:db_trace:kst.c@679:kstipg(): [10280:26:0] kst: process info: ospid=16472 pso_num=26 pso_serial#=183 2025-06-28 05:59:39.192498 :AAA4C3FD:db_trace:kso.c@4070:ksonfy(): [10420:26:0] kso: new process: pid=16472 (legacy spawn) 2025-06-28 05:59:39.198923 :AAA4C3FE:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:26:209] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-28 05:59:39.199097 :AAA4C403:db_trace:ksl2.c@12699:ksliwat(): [10005:26:209] 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-28 05:59:39.199901 :AAA4C408:db_trace:kst.c@698:kstpsodel(): [10280:26:0] kst: process state object about to be deleted 2025-06-28 05:59:39.217478 :AAA4C40B:db_trace:kst.c@673:kstipg(): [10280:26:0] kst: process state object created on 06-28 05:59:39.209 2025-06-28 05:59:39.217480 :AAA4C40C:db_trace:kst.c@679:kstipg(): [10280:26:0] kst: process info: ospid=11632 pso_num=26 pso_serial#=184 2025-06-28 05:59:39.217612 :AAA4C40D:db_trace:kso.c@4070:ksonfy(): [10420:26:0] kso: new process: pid=11632 (legacy spawn) 2025-06-28 05:59:39.224007 :AAA4C40E:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:26:209] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-28 05:59:39.224176 :AAA4C417:db_trace:ksl2.c@12699:ksliwat(): [10005:26:209] 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-28 05:59:39.224962 :AAA4C418:db_trace:kst.c@698:kstpsodel(): [10280:26:0] kst: process state object about to be deleted 2025-06-28 05:59:42.497788 :AAA4C534:db_trace:kst.c@673:kstipg(): [10280:26:0] kst: process state object created on 06-28 05:59:42.485 2025-06-28 05:59:42.497790 :AAA4C535:db_trace:kst.c@679:kstipg(): [10280:26:0] kst: process info: ospid=18412 pso_num=26 pso_serial#=185 2025-06-28 05:59:42.497928 :AAA4C536:db_trace:kso.c@4070:ksonfy(): [10420:26:0] kso: new process: pid=18412 (legacy spawn) 2025-06-28 05:59:42.504425 :AAA4C537:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:26:209] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-28 05:59:42.504601 :AAA4C53C:db_trace:ksl2.c@12699:ksliwat(): [10005:26:209] 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-28 05:59:42.505391 :AAA4C541:db_trace:kst.c@698:kstpsodel(): [10280:26:0] kst: process state object about to be deleted 2025-06-28 05:59:42.514107 :AAA4C544:db_trace:kst.c@673:kstipg(): [10280:26:0] kst: process state object created on 06-28 05:59:42.501 2025-06-28 05:59:42.514109 :AAA4C545:db_trace:kst.c@679:kstipg(): [10280:26:0] kst: process info: ospid=15136 pso_num=26 pso_serial#=186 2025-06-28 05:59:42.514245 :AAA4C546:db_trace:kso.c@4070:ksonfy(): [10420:26:0] kso: new process: pid=15136 (legacy spawn) 2025-06-28 05:59:42.520688 :AAA4C547:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:26:209] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-28 05:59:42.520853 :AAA4C54F:db_trace:ksl2.c@12699:ksliwat(): [10005:26:209] 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-28 05:59:42.521654 :AAA4C550:db_trace:kst.c@698:kstpsodel(): [10280:26:0] kst: process state object about to be deleted 2025-06-28 05:59:51.747425 :AAA4C842:db_trace:kst.c@673:kstipg(): [10280:26:0] kst: process state object created on 06-28 05:59:51.739 2025-06-28 05:59:51.747427 :AAA4C843:db_trace:kst.c@679:kstipg(): [10280:26:0] kst: process info: ospid=15168 pso_num=26 pso_serial#=187 2025-06-28 05:59:51.747562 :AAA4C844:db_trace:kso.c@4070:ksonfy(): [10420:26:0] kso: new process: pid=15168 (legacy spawn) 2025-06-28 05:59:51.754072 :AAA4C845:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:26:209] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-28 05:59:51.754245 :AAA4C84A:db_trace:ksl2.c@12699:ksliwat(): [10005:26:209] 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-28 05:59:51.755044 :AAA4C84F:db_trace:kst.c@698:kstpsodel(): [10280:26:0] kst: process state object about to be deleted 2025-06-28 05:59:53.370244 :AAA4C893:db_trace:kst.c@673:kstipg(): [10280:26:0] kst: process state object created on 06-28 05:59:53.357 2025-06-28 05:59:53.370246 :AAA4C894:db_trace:kst.c@679:kstipg(): [10280:26:0] kst: process info: ospid=17248 pso_num=26 pso_serial#=188 2025-06-28 05:59:53.370386 :AAA4C895:db_trace:kso.c@4070:ksonfy(): [10420:26:0] kso: new process: pid=17248 (legacy spawn) 2025-06-28 05:59:53.376785 :AAA4C896:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:26:209] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-28 05:59:53.376981 :AAA4C89C:db_trace:ksl2.c@12699:ksliwat(): [10005:26:209] 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-28 05:59:53.377763 :AAA4C8A0:db_trace:kst.c@698:kstpsodel(): [10280:26:0] kst: process state object about to be deleted 2025-06-28 06:00:02.217136 :AAA4CD16:db_trace:kst.c@673:kstipg(): [10280:26:0] kst: process state object created on 06-28 06:00:02.206 2025-06-28 06:00:02.217138 :AAA4CD17:db_trace:kst.c@679:kstipg(): [10280:26:0] kst: process info: ospid=11192 pso_num=26 pso_serial#=189 2025-06-28 06:00:02.217270 :AAA4CD18:db_trace:kso.c@4093:ksonfy(): [10420:26:0] kso: new process: pid=11192 osp_idx=24 osp_ver=526254 osp_pg=0 (spawn #330276) 2025-06-28 06:00:02.217270 :AAA4CD19:db_trace:kso.c@4099:ksonfy(): [10420:26:0] kso: new process: first_req_pid=4308 spawner_pid=3660 sga_crt_ts=x8A8A 2025-06-28 06:00:02.217271 :AAA4CD1A:db_trace:kso.c@4103:ksonfy(): [10420:26:0] kso: new process: pso_index=26 reservation=70 time=4066145407 2025-06-28 06:00:02.217271 :AAA4CD1B:db_trace:kso.c@4109:ksonfy(): [10420:26:0] kso: spawn diagnostics: queue time=0 secs 2025-06-28 06:00:02.217272 :AAA4CD1C:db_trace:kso.c@4111:ksonfy(): [10420:26:0] kso: spawn diagnostics: fork time=0 secs 2025-06-28 06:00:02.217272 :AAA4CD1D:db_trace:kso.c@4113:ksonfy(): [10420:26:0] kso: spawn diagnostics: exec time=0 secs 2025-06-28 06:00:02.217272 :AAA4CD1E:db_trace:kso.c@4115:ksonfy(): [10420:26:0] kso: spawn diagnostics: pre dbkc time=0 secs 2025-06-28 06:00:02.217273 :AAA4CD1F:db_trace:kso.c@4117:ksonfy(): [10420:26:0] kso: spawn diagnostics: post dbkc time=0 secs 2025-06-28 06:00:02.217757 :AAA4CD20:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:26:209] KSL POST SENT postee=59 loc='kso2.h LINE:416 ID:ksoreq_reply' id1=0 id2=0 name= type=0 2025-06-28 06:00:02.222772 :AAA4CD48:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:26:209] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-28 06:00:02.222814 :AAA4CD4B:db_trace:ktc.c@8711:ktcAutoTxnTrace(): [10441:26:209] atxpus:jslv.c:9203 2025-06-28 06:00:02.226244 :AAA4CD66:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:26:209] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-28 06:00:02.540615 :AAA4D095:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:26:209] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-28 06:00:02.584415 :AAA4D09D:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:26:209] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-28 06:00:02.600266 :AAA4D0A5:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:26:209] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-28 06:00:02.657602 :AAA4D0B5:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:26:209] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-28 06:00:02.789816 :AAA4D0BD:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:26:209] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-28 06:00:02.802883 :AAA4D0C5:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:26:209] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-28 06:00:02.812716 :AAA4D0CD:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:26:209] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-28 06:00:02.827937 :AAA4D0D5:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:26:209] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-28 06:00:02.842715 :AAA4D0DD:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:26:209] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-28 06:00:02.858088 :AAA4D0E5:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:26:209] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-28 06:00:02.867878 :AAA4D0ED:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:26:209] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-28 06:00:02.883031 :AAA4D0F5:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:26:209] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-28 06:00:02.892609 :AAA4D0FD:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:26:209] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-28 06:00:02.908361 :AAA4D105:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:26:209] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-28 06:00:02.918530 :AAA4D10D:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:26:209] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-28 06:00:02.928330 :AAA4D142:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:26:209] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-28 06:00:02.943341 :AAA4D14A:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:26:209] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-28 06:00:02.952939 :AAA4D152:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:26:209] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-28 06:00:02.969141 :AAA4D15A:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:26:209] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-28 06:00:02.985475 :AAA4D162:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:26:209] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-28 06:00:03.001731 :AAA4D16A:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:26:209] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-28 06:00:03.018018 :AAA4D172:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:26:209] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-28 06:00:03.028055 :AAA4D17A:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:26:209] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-28 06:00:03.043543 :AAA4D182:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:26:209] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-28 06:00:03.053080 :AAA4D18A:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:26:209] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-28 06:00:03.063351 :AAA4D192:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:26:209] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-28 06:00:03.073351 :AAA4D19A:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:26:209] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-28 06:00:03.088860 :AAA4D1AE:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:26:209] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-28 06:00:03.098492 :AAA4D1B6:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:26:209] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-28 06:00:03.113788 :AAA4D1BE:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:26:209] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-28 06:00:03.120987 :AAA4D1C6:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:26:209] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-28 06:00:03.131059 :AAA4D1CE:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:26:209] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-28 06:00:03.146564 :AAA4D1D6:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:26:209] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-28 06:00:03.161759 :AAA4D1DE:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:26:209] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-28 06:00:03.171849 :AAA4D1E6:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:26:209] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-28 06:00:03.181103 :AAA4D1EE:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:26:209] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-28 06:00:03.195946 :AAA4D1F6:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:26:209] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-28 06:00:03.211047 :AAA4D1FE:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:26:209] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-28 06:00:03.226089 :AAA4D206:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:26:209] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-28 06:00:03.235434 :AAA4D20E:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:26:209] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-28 06:00:03.244989 :AAA4D216:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:26:209] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-28 06:00:03.255017 :AAA4D21E:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:26:209] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-28 06:00:03.266719 :AAA4D226:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:26:209] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-28 06:00:03.276410 :AAA4D22E:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:26:209] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-28 06:00:03.291587 :AAA4D236:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:26:209] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-28 06:00:03.301396 :AAA4D23E:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:26:209] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-28 06:00:03.308666 :AAA4D246:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:26:209] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-28 06:00:03.315938 :AAA4D24E:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:26:209] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-28 06:00:03.323197 :AAA4D256:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:26:209] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-28 06:00:03.330455 :AAA4D25E:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:26:209] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-28 06:00:03.338921 :AAA4D266:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:26:209] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-28 06:00:03.346293 :AAA4D26E:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:26:209] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-28 06:00:03.353558 :AAA4D276:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:26:209] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-28 06:00:03.360878 :AAA4D27E:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:26:209] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-28 06:00:03.518795*:AAA4D31D:sql_mon_query:keswx.c@6099:keswxCurPushMonitoring(begin): xsc=0x00000000292D6918 estart=1751061602 eid=16777409 ctx=0x00000007831EA738 cwh=0x00000000292A0068 cpu=156250 buffg=36660 interb=114688 r=7 rb=114688 w=0 wb=0 2025-06-28 06:00:03.518795*:AAA4D31E:sql_mon_query:keswx.c@2839:keswxCurPrepare(): Allocate monitor context: xsc=0x00000000292D6918 curCtx=0x000000003439C1B0 pubTabIdxCnt=0 2025-06-28 06:00:03.518795*:AAA4D31F:sql_mon_query:keswx.c@6131:keswxCurPushMonitoring(): clear monitoring flag for xsc=0x00000000292D6918 2025-06-28 06:00:03.518795*:AAA4D320:sql_mon_query:keswx.c@6263:keswxCurPushMonitoring(end): full monitoring not yet started for xsc=0x00000000292D6918 2025-06-28 06:00:03.518795*:AAA4D321:sql_mon_query:keswx.c@6099:keswxCurPushMonitoring(begin): xsc=0x00000000275EC288 estart=1751061601 eid=16777312 ctx=0x000000079F654AA8 cwh=0x00000000275E0158 cpu=0 buffg=124188 interb=28000256 r=1431 rb=25698304 w=12 wb=2301952 2025-06-28 06:00:03.518795*:AAA4D322:sql_mon_query:keswx.c@2839:keswxCurPrepare(): Allocate monitor context: xsc=0x00000000275EC288 curCtx=0x000000003427D000 pubTabIdxCnt=0 2025-06-28 06:00:03.518795*:AAA4D323:sql_mon_query:keswx.c@6131:keswxCurPushMonitoring(): clear monitoring flag for xsc=0x00000000275EC288 2025-06-28 06:00:03.518795*:AAA4D324:sql_mon_query:keswx.c@6263:keswxCurPushMonitoring(end): full monitoring not yet started for xsc=0x00000000275EC288 2025-06-28 06:00:03.909434*:AAA4D487:sql_mon_query:keswx.c@3282:keswxCurEndPlanMonitoringCb(begin): xsc=0x00000000292D6918 curCtx=0x000000003439C1B0 xsc->flg4=65792 flags=1 2025-06-28 06:00:03.909434*:AAA4D488:sql_mon_query:keswx.c@3389:keswxCurEndPlanMonitoringCb(end): monitoring has ended for xsc=0x00000000292D6918 2025-06-28 06:00:04.492123 :AAA4D53D:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:26:209] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-28 06:00:04.492497 :AAA4D545:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:26:209] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-28 06:00:04.492497*:AAA4D548:sql_mon_query:keswx.c@3282:keswxCurEndPlanMonitoringCb(begin): xsc=0x00000000275EC288 curCtx=0x000000003427D000 xsc->flg4=65792 flags=2 2025-06-28 06:00:04.492497*:AAA4D549:sql_mon_query:keswx.c@3389:keswxCurEndPlanMonitoringCb(end): monitoring has ended for xsc=0x00000000275EC288 2025-06-28 06:00:04.492751 :AAA4D54F:db_trace:ktc.c@8711:ktcAutoTxnTrace(): [10441:26:209] atxpop:jslv.c:9203 2025-06-28 06:00:04.497121 :AAA4D550:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:26:209] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-28 06:00:04.497203 :AAA4D553:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:26:209] KSL POST SENT postee=59 loc='kkj.h LINE:928 ID:jslve_execute' id1=0 id2=0 name= type=0 2025-06-28 06:00:04.497295 :AAA4D560:db_trace:ksl2.c@12699:ksliwat(): [10005:26:209] KSL POST RCVD poster=14 loc='ksl2.h LINE:2165 ID:kslpsr' id1=134 id2=0 name=EV type=0 fac#=0 facpost=1 ------------------------------------------------------------------------------- Trace Bucket Dump End: default bucket for process 26 (osid: 11192, J001)
Ms-Dos/Windows
Unix
Write backup
jsp File Browser version 1.2 by
www.vonloesch.de