Edit D:\app\Administrator\diag\rdbms\orcl\orcl\trace\cdmp_20250427060006\orcl_j003_10876_bucket.trc
Trace file d:\app\administrator\diag\rdbms\orcl\orcl\trace\cdmp_20250427060006\orcl_j003_10876_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:37591M/63366M, Ph+PgF:45267M/72582M Instance name: orcl Redo thread mounted by this instance: 1 Oracle process number: 29 Windows thread id: 10876, image: ORACLE.EXE (J003) *** 2025-04-27 06:00:06.296 *** SESSION ID:(233.19559) 2025-04-27 06:00:06.296 *** 2025-04-27 06:00:06.296 Process diagnostic dump for ORACLE.EXE (J003), OS id=10876, pid: 29, proc_ser: 71, sid: 233, sess_ser: 19559 ------------------------------------------------------------------------------- current sql: call dbms_stats.gather_database_stats_job_proc ( ) client details: O/S info: user: SYSTEM, term: WIN-3PIMCL4OH3L, ospid: 10876 machine: WIN-3PIMCL4OH3L program: ORACLE.EXE (J003) application name: DBMS_SCHEDULER, hash value=2478762354 action name: ORA$AT_OS_OPT_SY_12339, hash value=4155826127 Current Wait Stack: Not in wait; last wait ended 2.466235 sec ago Wait State: fixed_waits=0 flags=0x21 boundary=0x0000000000000000/-1 Session Wait History: elapsed time of 2.466260 sec since last wait 0: waited for 'Disk file operations I/O' FileOperation=0x2, fileno=0xc9, filetype=0x2 wait_id=41 seq_num=42 snap_id=1 wait times: snap=0.000146 sec, exc=0.000146 sec, total=0.000146 sec wait times: max=infinite wait counts: calls=0 os=0 occurred after 0.066148 sec of elapsed time 1: waited for 'asynch descriptor resize' outstanding #aio=0x0, current aio limit=0xffffffff, new aio limit=0x82 wait_id=40 seq_num=41 snap_id=1 wait times: snap=0.000009 sec, exc=0.000009 sec, total=0.000009 sec wait times: max=307445734561 min 49 sec wait counts: calls=0 os=0 occurred after 0.025166 sec of elapsed time 2: waited for 'Disk file operations I/O' FileOperation=0x2, fileno=0x3, filetype=0x2 wait_id=39 seq_num=40 snap_id=1 wait times: snap=0.000152 sec, exc=0.000152 sec, total=0.000152 sec wait times: max=infinite wait counts: calls=0 os=0 occurred after 0.728864 sec of elapsed time 3: waited for 'asynch descriptor resize' outstanding #aio=0x0, current aio limit=0xffffffff, new aio limit=0x82 wait_id=38 seq_num=39 snap_id=1 wait times: snap=0.000002 sec, exc=0.000002 sec, total=0.000002 sec wait times: max=307445734561 min 49 sec wait counts: calls=0 os=0 occurred after 0.025242 sec of elapsed time 4: waited for 'asynch descriptor resize' outstanding #aio=0x0, current aio limit=0xffffffff, new aio limit=0x82 wait_id=37 seq_num=38 snap_id=1 wait times: snap=0.000003 sec, exc=0.000003 sec, total=0.000003 sec wait times: max=307445734561 min 49 sec wait counts: calls=0 os=0 occurred after 0.012844 sec of elapsed time 5: waited for 'db file sequential read' file#=0x2, block#=0x78fa, blocks=0x1 wait_id=36 seq_num=37 snap_id=1 wait times: snap=0.000067 sec, exc=0.000067 sec, total=0.000067 sec wait times: max=infinite wait counts: calls=0 os=0 occurred after 0.049538 sec of elapsed time 6: waited for 'db file sequential read' file#=0x2, block#=0x1e5a, blocks=0x1 wait_id=35 seq_num=36 snap_id=1 wait times: snap=0.004464 sec, exc=0.004464 sec, total=0.004464 sec wait times: max=infinite wait counts: calls=0 os=0 occurred after 0.008036 sec of elapsed time 7: waited for 'db file sequential read' file#=0x1, block#=0x2d00, blocks=0x1 wait_id=34 seq_num=35 snap_id=1 wait times: snap=0.000133 sec, exc=0.000133 sec, total=0.000133 sec wait times: max=infinite wait counts: calls=0 os=0 occurred after 0.266056 sec of elapsed time 8: waited for 'db file sequential read' file#=0x1, block#=0x130, blocks=0x1 wait_id=33 seq_num=34 snap_id=1 wait times: snap=0.007148 sec, exc=0.007148 sec, total=0.007148 sec wait times: max=infinite wait counts: calls=0 os=0 occurred after 0.000173 sec of elapsed time 9: waited for 'db file sequential read' file#=0x1, block#=0xc8, blocks=0x1 wait_id=32 seq_num=33 snap_id=1 wait times: snap=0.000107 sec, exc=0.000107 sec, total=0.000107 sec wait times: max=infinite wait counts: calls=0 os=0 occurred after 0.007811 sec of elapsed time Sampled Session History of session 233 serial 19559 --------------------------------------------------- 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:02 - 06:00:06] not in wait at each sample [1 sample, 06:00:01] idle wait at each sample [session created at: 06:00:02] ------------------------------------------------------------------------------- Process diagnostic dump actual duration=0.000000 sec (max dump time=30.000000 sec) *** 2025-04-27 06:00:06.296 ------------------------------------------------------------------------------- Trace Bucket Dump Begin: default bucket for process 29 (osid: 10876, J003) TIME(*=approx):SEQ:COMPONENT:FILE@LINE:FUNCTION:SECT/DUMP: [EVENT#:PID:SID] DATA ------------------------------------------------------------------------------- 2025-04-27 00:37:37.057135 :8F3C3157:db_trace:kst.c@698:kstpsodel(): [10280:29:0] kst: process state object about to be deleted 2025-04-27 01:00:08.129302 :8F3DF951:db_trace:kst.c@673:kstipg(): [10280:29:0] kst: process state object created on 04-27 01:00:08.120 2025-04-27 01:00:08.129304 :8F3DF952:db_trace:kst.c@679:kstipg(): [10280:29:0] kst: process info: ospid=2292 pso_num=29 pso_serial#=62 2025-04-27 01:00:08.129434 :8F3DF953:db_trace:kso.c@4070:ksonfy(): [10420:29:0] kso: new process: pid=2292 (legacy spawn) 2025-04-27 01:00:08.135863 :8F3DF954: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-04-27 01:00:08.136040 :8F3DF959: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-04-27 01:00:08.136854 :8F3DF95E:db_trace:kst.c@698:kstpsodel(): [10280:29:0] kst: process state object about to be deleted 2025-04-27 01:00:14.489448 :8F3DFC43:db_trace:kst.c@673:kstipg(): [10280:29:0] kst: process state object created on 04-27 01:00:14.481 2025-04-27 01:00:14.489450 :8F3DFC44:db_trace:kst.c@679:kstipg(): [10280:29:0] kst: process info: ospid=4696 pso_num=29 pso_serial#=63 2025-04-27 01:00:14.489586 :8F3DFC45:db_trace:kso.c@4070:ksonfy(): [10420:29:0] kso: new process: pid=4696 (legacy spawn) 2025-04-27 01:00:14.496037 :8F3DFC46: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-04-27 01:00:14.496210 :8F3DFC4B: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-04-27 01:00:14.497018 :8F3DFC50:db_trace:kst.c@698:kstpsodel(): [10280:29:0] kst: process state object about to be deleted 2025-04-27 01:00:18.192717 :8F3DFD74:db_trace:kst.c@673:kstipg(): [10280:29:0] kst: process state object created on 04-27 01:00:18.184 2025-04-27 01:00:18.192719 :8F3DFD75:db_trace:kst.c@679:kstipg(): [10280:29:0] kst: process info: ospid=10796 pso_num=29 pso_serial#=64 2025-04-27 01:00:18.192857 :8F3DFD76:db_trace:kso.c@4070:ksonfy(): [10420:29:0] kso: new process: pid=10796 (legacy spawn) 2025-04-27 01:00:18.199357 :8F3DFD77: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-04-27 01:00:18.199530 :8F3DFD7F: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-04-27 01:00:18.200396 :8F3DFD81:db_trace:kst.c@698:kstpsodel(): [10280:29:0] kst: process state object about to be deleted 2025-04-27 01:00:18.209089 :8F3DFD84:db_trace:kst.c@673:kstipg(): [10280:29:0] kst: process state object created on 04-27 01:00:18.200 2025-04-27 01:00:18.209092 :8F3DFD85:db_trace:kst.c@679:kstipg(): [10280:29:0] kst: process info: ospid=7380 pso_num=29 pso_serial#=65 2025-04-27 01:00:18.209240 :8F3DFD86:db_trace:kso.c@4070:ksonfy(): [10420:29:0] kso: new process: pid=7380 (legacy spawn) 2025-04-27 01:00:18.215669 :8F3DFD8F: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-04-27 01:00:18.215840 :8F3DFD98: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-04-27 01:00:18.216728 :8F3DFD99:db_trace:kst.c@698:kstpsodel(): [10280:29:0] kst: process state object about to be deleted 2025-04-27 01:00:21.400548 :8F3DFEB0:db_trace:kst.c@673:kstipg(): [10280:29:0] kst: process state object created on 04-27 01:00:21.388 2025-04-27 01:00:21.400550 :8F3DFEB1:db_trace:kst.c@679:kstipg(): [10280:29:0] kst: process info: ospid=10216 pso_num=29 pso_serial#=66 2025-04-27 01:00:21.400692 :8F3DFEB2:db_trace:kso.c@4070:ksonfy(): [10420:29:0] kso: new process: pid=10216 (legacy spawn) 2025-04-27 01:00:21.407280 :8F3DFEB3: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-04-27 01:00:21.407447 :8F3DFEBC: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-04-27 01:00:21.408258 :8F3DFEBD:db_trace:kst.c@698:kstpsodel(): [10280:29:0] kst: process state object about to be deleted 2025-04-27 01:00:21.416934 :8F3DFEC0:db_trace:kst.c@673:kstipg(): [10280:29:0] kst: process state object created on 04-27 01:00:21.403 2025-04-27 01:00:21.416936 :8F3DFEC1:db_trace:kst.c@679:kstipg(): [10280:29:0] kst: process info: ospid=11164 pso_num=29 pso_serial#=67 2025-04-27 01:00:21.417069 :8F3DFEC2:db_trace:kso.c@4070:ksonfy(): [10420:29:0] kso: new process: pid=11164 (legacy spawn) 2025-04-27 01:00:21.423532 :8F3DFEC3: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-04-27 01:00:21.423693 :8F3DFECC: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-04-27 01:00:21.424474 :8F3DFECD:db_trace:kst.c@698:kstpsodel(): [10280:29:0] kst: process state object about to be deleted 2025-04-27 01:00:41.139525 :8F3E05C3:db_trace:kst.c@673:kstipg(): [10280:29:0] kst: process state object created on 04-27 01:00:41.136 2025-04-27 01:00:41.139527 :8F3E05C4:db_trace:kst.c@679:kstipg(): [10280:29:0] kst: process info: ospid=7348 pso_num=29 pso_serial#=68 2025-04-27 01:00:41.139660 :8F3E05C5:db_trace:kso.c@4093:ksonfy(): [10420:29:0] kso: new process: pid=7348 osp_idx=27 osp_ver=9757 osp_pg=0 (spawn #122034) 2025-04-27 01:00:41.139660 :8F3E05C6:db_trace:kso.c@4099:ksonfy(): [10420:29:0] kso: new process: first_req_pid=3704 spawner_pid=3660 sga_crt_ts=x8A8A 2025-04-27 01:00:41.139661 :8F3E05C7:db_trace:kso.c@4103:ksonfy(): [10420:29:0] kso: new process: pso_index=29 reservation=83 time=2986442921 2025-04-27 01:00:41.139661 :8F3E05C8:db_trace:kso.c@4109:ksonfy(): [10420:29:0] kso: spawn diagnostics: queue time=0 secs 2025-04-27 01:00:41.139661 :8F3E05C9:db_trace:kso.c@4111:ksonfy(): [10420:29:0] kso: spawn diagnostics: fork time=0 secs 2025-04-27 01:00:41.139662 :8F3E05CA:db_trace:kso.c@4113:ksonfy(): [10420:29:0] kso: spawn diagnostics: exec time=0 secs 2025-04-27 01:00:41.139662 :8F3E05CB:db_trace:kso.c@4115:ksonfy(): [10420:29:0] kso: spawn diagnostics: pre dbkc time=0 secs 2025-04-27 01:00:41.139663 :8F3E05CC:db_trace:kso.c@4117:ksonfy(): [10420:29:0] kso: spawn diagnostics: post dbkc time=0 secs 2025-04-27 01:00:41.140153 :8F3E05CD: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-04-27 01:00:41.140209 :8F3E05D3: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-04-27 01:00:41.147389 :8F3E05E1: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-04-27 01:00:41.148458 :8F3E05E9: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-04-27 01:00:41.149032 :8F3E05F1: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-04-27 01:00:41.149496 :8F3E05F9: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-04-27 01:00:41.150004 :8F3E0601: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-04-27 01:00:41.152466 :8F3E0609: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-04-27 01:00:41.153578 :8F3E0611: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-04-27 01:00:41.203005 :8F3E0619: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-04-27 01:00:41.203921 :8F3E0621: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-04-27 01:00:41.204196 :8F3E0629: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-04-27 01:00:41.204430 :8F3E0631: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-04-27 01:00:41.206087 :8F3E0639:db_trace:kst.c@698:kstpsodel(): [10280:29:0] kst: process state object about to be deleted 2025-04-27 01:07:40.655516 :8F3E9C44:db_trace:kst.c@673:kstipg(): [10280:29:0] kst: process state object created on 04-27 01:07:40.643 2025-04-27 01:07:40.655518 :8F3E9C45:db_trace:kst.c@679:kstipg(): [10280:29:0] kst: process info: ospid=9796 pso_num=29 pso_serial#=69 2025-04-27 01:07:40.655659 :8F3E9C46:db_trace:kso.c@4093:ksonfy(): [10420:29:0] kso: new process: pid=9796 osp_idx=27 osp_ver=9758 osp_pg=0 (spawn #122052) 2025-04-27 01:07:40.655659 :8F3E9C47:db_trace:kso.c@4099:ksonfy(): [10420:29:0] kso: new process: first_req_pid=3704 spawner_pid=3660 sga_crt_ts=x8A8A 2025-04-27 01:07:40.655660 :8F3E9C48:db_trace:kso.c@4103:ksonfy(): [10420:29:0] kso: new process: pso_index=29 reservation=84 time=2986862437 2025-04-27 01:07:40.655660 :8F3E9C49:db_trace:kso.c@4109:ksonfy(): [10420:29:0] kso: spawn diagnostics: queue time=0 secs 2025-04-27 01:07:40.655660 :8F3E9C4A:db_trace:kso.c@4111:ksonfy(): [10420:29:0] kso: spawn diagnostics: fork time=0 secs 2025-04-27 01:07:40.655661 :8F3E9C4B:db_trace:kso.c@4113:ksonfy(): [10420:29:0] kso: spawn diagnostics: exec time=0 secs 2025-04-27 01:07:40.655661 :8F3E9C4C:db_trace:kso.c@4115:ksonfy(): [10420:29:0] kso: spawn diagnostics: pre dbkc time=0 secs 2025-04-27 01:07:40.655662 :8F3E9C4D:db_trace:kso.c@4117:ksonfy(): [10420:29:0] kso: spawn diagnostics: post dbkc time=0 secs 2025-04-27 01:07:40.656175 :8F3E9C4E: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-04-27 01:07:40.656216 :8F3E9C54: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-04-27 01:07:40.660263 :8F3E9C7D:db_trace:ktc.c@8711:ktcAutoTxnTrace(): [10441:29:233] atxpus:kelt.c:517 2025-04-27 01:07:40.660305 :8F3E9C7E:db_trace:ktc.c@8711:ktcAutoTxnTrace(): [10441:29:233] atxpop:kelt.c:517 2025-04-27 01:07:40.660557 :8F3E9C7F:db_trace:ktc.c@8711:ktcAutoTxnTrace(): [10441:29:233] atxpus:kelt.c:517 2025-04-27 01:07:40.660573 :8F3E9C80:db_trace:ktc.c@8711:ktcAutoTxnTrace(): [10441:29:233] atxpop:kelt.c:517 2025-04-27 01:07:40.660781 :8F3E9C81:db_trace:ktc.c@8711:ktcAutoTxnTrace(): [10441:29:233] atxpus:kelt.c:517 2025-04-27 01:07:40.660795 :8F3E9C82:db_trace:ktc.c@8711:ktcAutoTxnTrace(): [10441:29:233] atxpop:kelt.c:517 2025-04-27 01:07:40.660998 :8F3E9C83:db_trace:ktc.c@8711:ktcAutoTxnTrace(): [10441:29:233] atxpus:kelt.c:517 2025-04-27 01:07:40.661011 :8F3E9C84:db_trace:ktc.c@8711:ktcAutoTxnTrace(): [10441:29:233] atxpop:kelt.c:517 2025-04-27 01:07:40.661217 :8F3E9C85:db_trace:ktc.c@8711:ktcAutoTxnTrace(): [10441:29:233] atxpus:kelt.c:517 2025-04-27 01:07:40.661229 :8F3E9C86:db_trace:ktc.c@8711:ktcAutoTxnTrace(): [10441:29:233] atxpop:kelt.c:517 2025-04-27 01:07:40.661424 :8F3E9C87:db_trace:ktc.c@8711:ktcAutoTxnTrace(): [10441:29:233] atxpus:kelt.c:517 2025-04-27 01:07:40.661437 :8F3E9C88:db_trace:ktc.c@8711:ktcAutoTxnTrace(): [10441:29:233] atxpop:kelt.c:517 2025-04-27 01:07:40.663820 :8F3E9C89:db_trace:kst.c@698:kstpsodel(): [10280:29:0] kst: process state object about to be deleted 2025-04-27 01:37:44.611290 :8F40FC4D:db_trace:kst.c@673:kstipg(): [10280:29:0] kst: process state object created on 04-27 01:37:44.599 2025-04-27 01:37:44.611292 :8F40FC4E:db_trace:kst.c@679:kstipg(): [10280:29:0] kst: process info: ospid=7588 pso_num=29 pso_serial#=70 2025-04-27 01:37:44.611423 :8F40FC4F:db_trace:kso.c@4093:ksonfy(): [10420:29:0] kso: new process: pid=7588 osp_idx=27 osp_ver=9759 osp_pg=0 (spawn #122122) 2025-04-27 01:37:44.611423 :8F40FC50:db_trace:kso.c@4099:ksonfy(): [10420:29:0] kso: new process: first_req_pid=3704 spawner_pid=3660 sga_crt_ts=x8A8A 2025-04-27 01:37:44.611424 :8F40FC51:db_trace:kso.c@4103:ksonfy(): [10420:29:0] kso: new process: pso_index=29 reservation=85 time=2988666406 2025-04-27 01:37:44.611424 :8F40FC52:db_trace:kso.c@4109:ksonfy(): [10420:29:0] kso: spawn diagnostics: queue time=0 secs 2025-04-27 01:37:44.611424 :8F40FC53:db_trace:kso.c@4111:ksonfy(): [10420:29:0] kso: spawn diagnostics: fork time=0 secs 2025-04-27 01:37:44.611425 :8F40FC54:db_trace:kso.c@4113:ksonfy(): [10420:29:0] kso: spawn diagnostics: exec time=0 secs 2025-04-27 01:37:44.611425 :8F40FC55:db_trace:kso.c@4115:ksonfy(): [10420:29:0] kso: spawn diagnostics: pre dbkc time=0 secs 2025-04-27 01:37:44.611426 :8F40FC56:db_trace:kso.c@4117:ksonfy(): [10420:29:0] kso: spawn diagnostics: post dbkc time=0 secs 2025-04-27 01:37:44.611927 :8F40FC57: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-04-27 01:37:44.611970 :8F40FC5D: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-04-27 01:37:44.616122 :8F40FC76:db_trace:ktc.c@8711:ktcAutoTxnTrace(): [10441:29:233] atxpus:kelt.c:517 2025-04-27 01:37:44.616164 :8F40FC77:db_trace:ktc.c@8711:ktcAutoTxnTrace(): [10441:29:233] atxpop:kelt.c:517 2025-04-27 01:37:44.616419 :8F40FC78:db_trace:ktc.c@8711:ktcAutoTxnTrace(): [10441:29:233] atxpus:kelt.c:517 2025-04-27 01:37:44.616434 :8F40FC79:db_trace:ktc.c@8711:ktcAutoTxnTrace(): [10441:29:233] atxpop:kelt.c:517 2025-04-27 01:37:44.616642 :8F40FC7A:db_trace:ktc.c@8711:ktcAutoTxnTrace(): [10441:29:233] atxpus:kelt.c:517 2025-04-27 01:37:44.616655 :8F40FC7B:db_trace:ktc.c@8711:ktcAutoTxnTrace(): [10441:29:233] atxpop:kelt.c:517 2025-04-27 01:37:44.616862 :8F40FC7C:db_trace:ktc.c@8711:ktcAutoTxnTrace(): [10441:29:233] atxpus:kelt.c:517 2025-04-27 01:37:44.616875 :8F40FC7D:db_trace:ktc.c@8711:ktcAutoTxnTrace(): [10441:29:233] atxpop:kelt.c:517 2025-04-27 01:37:44.617076 :8F40FC7E:db_trace:ktc.c@8711:ktcAutoTxnTrace(): [10441:29:233] atxpus:kelt.c:517 2025-04-27 01:37:44.617089 :8F40FC7F:db_trace:ktc.c@8711:ktcAutoTxnTrace(): [10441:29:233] atxpop:kelt.c:517 2025-04-27 01:37:44.617288 :8F40FC80:db_trace:ktc.c@8711:ktcAutoTxnTrace(): [10441:29:233] atxpus:kelt.c:517 2025-04-27 01:37:44.617301 :8F40FC81:db_trace:ktc.c@8711:ktcAutoTxnTrace(): [10441:29:233] atxpop:kelt.c:517 2025-04-27 01:37:44.619644 :8F40FC82:db_trace:kst.c@698:kstpsodel(): [10280:29:0] kst: process state object about to be deleted 2025-04-27 06:00:02.046294 :8F55EF07:db_trace:kst.c@673:kstipg(): [10280:29:0] kst: process state object created on 04-27 06:00:02.035 2025-04-27 06:00:02.046295 :8F55EF08:db_trace:kst.c@679:kstipg(): [10280:29:0] kst: process info: ospid=10876 pso_num=29 pso_serial#=71 2025-04-27 06:00:02.046415 :8F55EF0E:db_trace:kso.c@4093:ksonfy(): [10420:29:0] kso: new process: pid=10876 osp_idx=27 osp_ver=9760 osp_pg=0 (spawn #122741) 2025-04-27 06:00:02.046416 :8F55EF10:db_trace:kso.c@4099:ksonfy(): [10420:29:0] kso: new process: first_req_pid=4308 spawner_pid=3660 sga_crt_ts=x8A8A 2025-04-27 06:00:02.046417 :8F55EF11:db_trace:kso.c@4103:ksonfy(): [10420:29:0] kso: new process: pso_index=29 reservation=86 time=3004403843 2025-04-27 06:00:02.046417 :8F55EF12:db_trace:kso.c@4109:ksonfy(): [10420:29:0] kso: spawn diagnostics: queue time=0 secs 2025-04-27 06:00:02.046418 :8F55EF13:db_trace:kso.c@4111:ksonfy(): [10420:29:0] kso: spawn diagnostics: fork time=0 secs 2025-04-27 06:00:02.046418 :8F55EF14:db_trace:kso.c@4113:ksonfy(): [10420:29:0] kso: spawn diagnostics: exec time=0 secs 2025-04-27 06:00:02.046419 :8F55EF15:db_trace:kso.c@4115:ksonfy(): [10420:29:0] kso: spawn diagnostics: pre dbkc time=0 secs 2025-04-27 06:00:02.046419 :8F55EF16:db_trace:kso.c@4117:ksonfy(): [10420:29:0] kso: spawn diagnostics: post dbkc time=0 secs 2025-04-27 06:00:02.046942 :8F55EF17: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-04-27 06:00:02.051877 :8F55EF2C: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-04-27 06:00:02.051926 :8F55EF2F:db_trace:ktc.c@8711:ktcAutoTxnTrace(): [10441:29:233] atxpus:jslv.c:9203 2025-04-27 06:00:02.069037 :8F55F0FD: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-04-27 06:00:02.069266 :8F55F105: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-04-27 06:00:02.069437 :8F55F10D: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-04-27 06:00:02.069614 :8F55F115: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-04-27 06:00:02.069800 :8F55F11D: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-04-27 06:00:02.069966 :8F55F126: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-04-27 06:00:02.070133 :8F55F12E: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-04-27 06:00:02.070291 :8F55F149: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-04-27 06:00:02.070456 :8F55F156: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-04-27 06:00:02.070613 :8F55F15E: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-04-27 06:00:02.071215 :8F55F166: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-04-27 06:00:02.071464 :8F55F16E: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-04-27 06:00:02.071688 :8F55F176: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-04-27 06:00:02.071855 :8F55F17E: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-04-27 06:00:02.072030 :8F55F186: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-04-27 06:00:02.072190 :8F55F18E: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-04-27 06:00:02.072349 :8F55F196: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-04-27 06:00:02.072510 :8F55F19E: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-04-27 06:00:02.072663 :8F55F1A6: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-04-27 06:00:02.072842 :8F55F1AE: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-04-27 06:00:02.073008 :8F55F1B6: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-04-27 06:00:02.073163 :8F55F1BE: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-04-27 06:00:02.073313 :8F55F1C6: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-04-27 06:00:02.073476 :8F55F1CE: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-04-27 06:00:02.073633 :8F55F1D6: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-04-27 06:00:02.073786 :8F55F1DE: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-04-27 06:00:02.073942 :8F55F1E6: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-04-27 06:00:02.090950 :8F55F1F2:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:29:233] KSL POST SENT postee=14 loc='kcrf.h LINE:3299 ID:kcrfw_redo_gen: wake LGWR after redo copy' id1=0 id2=0 name= type=0 2025-04-27 06:00:02.102122 :8F55F202: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-04-27 06:00:03.748253 :8F55F551:db_trace:ktu.c@4871:ktuaex1r(): [10442:29:233] Extension usn 7, ext 0, nex 2 2025-04-27 06:00:03.748259 :8F55F552:db_trace:ktusm.c@2117:ktusmasp(): [10445:29:233] des1:tsn:1 rdba:0x00818fe2 where: kduwh01: kdusru 2025-04-27 06:00:03.754324 :8F55F553: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-04-27 06:00:03.775475 :8F55F55B: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-04-27 06:00:03.777755 :8F55F563:db_trace:ktc.c@8711:ktcAutoTxnTrace(): [10441:29:233] atxpus:psdpgi.c:2235 2025-04-27 06:00:03.777995 :8F55F564:db_trace:ktc.c@8711:ktcAutoTxnTrace(): [10441:29:233] atxpop:psdpgi.c:2235 2025-04-27 06:00:03.778996 :8F55F565: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-04-27 06:00:03.779101 :8F55F568: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-04-27 06:00:03.780093 :8F55F57A: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-04-27 06:00:03.781858 :8F55F582: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-04-27 06:00:03.782200 :8F55F58A: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-04-27 06:00:03.826558*:8F55F592:sql_mon_query:keswx.c@6099:keswxCurPushMonitoring(begin): xsc=0x0000000037470230 estart=1745704802 eid=16777475 ctx=0x000000079F4EAD08 cwh=0x000000002B4D0338 cpu=15625 buffg=0 interb=0 r=0 rb=0 w=0 wb=0 2025-04-27 06:00:03.826558*:8F55F593:sql_mon_query:keswx.c@2839:keswxCurPrepare(): Allocate monitor context: xsc=0x0000000037470230 curCtx=0x0000000037972A50 pubTabIdxCnt=0 2025-04-27 06:00:03.826558*:8F55F594:sql_mon_query:keswx.c@6131:keswxCurPushMonitoring(): clear monitoring flag for xsc=0x0000000037470230 2025-04-27 06:00:03.826558*:8F55F595:sql_mon_query:keswx.c@6263:keswxCurPushMonitoring(end): full monitoring not yet started for xsc=0x0000000037470230 2025-04-27 06:00:03.826558*:8F55F59E:sql_mon_query:keswx.c@3282:keswxCurEndPlanMonitoringCb(begin): xsc=0x0000000037470230 curCtx=0x0000000037972A50 xsc->flg4=65792 flags=1 2025-04-27 06:00:03.826558*:8F55F59F:sql_mon_query:keswx.c@3389:keswxCurEndPlanMonitoringCb(end): monitoring has ended for xsc=0x0000000037470230 2025-04-27 06:00:03.842185*:SQL_Analyze:qksan.c@3402:qksanAnalyzeSql(begin): qksanAnalyzeSql(enter): goal=15 options=16778048 pgadep=0 binds#=0 byPos=0 timeLim=0 timeFired=0 2025-04-27 06:00:03.842185*:SQL_Analyze:qksan.c@936:qksanBindSql(begin): binding for SQL analyze 2025-04-27 06:00:03.842185*:SQL_Analyze:qksan.c@1344:qksanBindSql(end): Done binding: status=0 ret=0 bind#=0 byPos=1 wasBoundP=0x0000000000000000 bindIndP=0x0000000000000000 2025-04-27 06:00:03.842185*:SQL_Analyze:qksan.c@6338:qksanAvgExecStats(): The number of total executions: 1 and execution count: 0 2025-04-27 06:00:03.842185*:SQL_Analyze:qksan.c@4776:qksanPostAnalyzeDump(begin): qksanPostAnalyzeDump(): Dumping analyze context after compilation qksanStatus=SUCCESS ecode=0 2025-04-27 06:00:03.842185*:SQL_Analyze:qksan.c@4800:qksanPostAnalyzeDump(end): 2025-04-27 06:00:03.842185*:SQL_Analyze:qksan.c@3690:qksanAnalyzeSql(end): exit: ecode=0 status=0 2025-04-27 06:00:03.915174 :8F55F5D2: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-04-27 06:00:05.785029 :8F55F6B2: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-04-27 06:00:05.785041 :8F55F6B3:db_trace:ktur.c@3079:ktuabt(): [10444:29:233] ABORT TRANSACTION - xid: 0x0009.00f.0001c37e ------------------------------------------------------------------------------- Trace Bucket Dump End: default bucket for process 29 (osid: 10876, J003)
Ms-Dos/Windows
Unix
Write backup
jsp File Browser version 1.2 by
www.vonloesch.de