Trace file d:\app\administrator\diag\rdbms\orcl\orcl\trace\cdmp_20250625220010\orcl_j005_17724_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:36356M/63366M, Ph+PgF:42541M/72582M Instance name: orcl Redo thread mounted by this instance: 1 Oracle process number: 31 Windows thread id: 17724, image: ORACLE.EXE (J005) *** 2025-06-25 22:00:10.371 *** SESSION ID:(249.1165) 2025-06-25 22:00:10.371 *** 2025-06-25 22:00:10.371 Process diagnostic dump for ORACLE.EXE (J005), OS id=17724, pid: 31, proc_ser: 56, sid: 249, sess_ser: 1165 ------------------------------------------------------------------------------- current sql: client details: O/S info: user: SYSTEM, term: WIN-3PIMCL4OH3L, ospid: 17724 machine: WIN-3PIMCL4OH3L program: ORACLE.EXE (J005) Current Wait Stack: 0: waiting for 'jobq slave wait' =0x0, =0x0, =0x0 wait_id=16 seq_num=17 snap_id=1 wait times: snap=0.331568 sec, exc=0.331568 sec, total=0.331568 sec wait times: max=0.500000 sec, heur=8.328777 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.000012 sec since current wait 0: waited for 'jobq slave wait' =0x0, =0x0, =0x0 wait_id=15 seq_num=16 snap_id=1 wait times: snap=0.499998 sec, exc=0.499998 sec, total=0.499998 sec wait times: max=0.500000 sec wait counts: calls=1 os=1 occurred after 0.000011 sec of elapsed time 1: waited for 'jobq slave wait' =0x0, =0x0, =0x0 wait_id=14 seq_num=15 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.000006 sec of elapsed time 2: waited for 'jobq slave wait' =0x0, =0x0, =0x0 wait_id=13 seq_num=14 snap_id=1 wait times: snap=0.505094 sec, exc=0.505094 sec, total=0.505094 sec wait times: max=0.500000 sec wait counts: calls=1 os=1 occurred after 0.000009 sec of elapsed time 3: waited for 'jobq slave wait' =0x0, =0x0, =0x0 wait_id=12 seq_num=13 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 4: waited for 'jobq slave wait' =0x0, =0x0, =0x0 wait_id=11 seq_num=12 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.000009 sec of elapsed time 5: waited for 'jobq slave wait' =0x0, =0x0, =0x0 wait_id=10 seq_num=11 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.000013 sec of elapsed time 6: waited for 'jobq slave wait' =0x0, =0x0, =0x0 wait_id=9 seq_num=10 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.000012 sec of elapsed time 7: waited for 'jobq slave wait' =0x0, =0x0, =0x0 wait_id=8 seq_num=9 snap_id=1 wait times: snap=0.500103 sec, exc=0.500103 sec, total=0.500103 sec wait times: max=0.500000 sec wait counts: calls=1 os=1 occurred after 0.000010 sec of elapsed time 8: waited for 'jobq slave wait' =0x0, =0x0, =0x0 wait_id=7 seq_num=8 snap_id=1 wait times: snap=0.500101 sec, exc=0.500101 sec, total=0.500101 sec wait times: max=0.500000 sec wait counts: calls=1 os=1 occurred after 0.000019 sec of elapsed time 9: waited for 'jobq slave wait' =0x0, =0x0, =0x0 wait_id=6 seq_num=7 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.000010 sec of elapsed time Sampled Session History of session 249 serial 1165 --------------------------------------------------- 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 --------------------------------------------------- [9 samples, 22:00:02 - 22:00:10] idle wait at each sample [session created at: 22:00:02] ------------------------------------------------------------------------------- Process diagnostic dump actual duration=0.000000 sec (max dump time=30.000000 sec) *** 2025-06-25 22:00:10.371 ------------------------------------------------------------------------------- Trace Bucket Dump Begin: default bucket for process 31 (osid: 17724, J005) TIME(*=approx):SEQ:COMPONENT:FILE@LINE:FUNCTION:SECT/DUMP: [EVENT#:PID:SID] DATA ------------------------------------------------------------------------------- 2025-06-23 00:00:13.099899 :A8508903:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-23 00:00:13.111056 :A8508920:db_trace:kwqid.c@2146:kwqidrdq(): [10960:31:249] kwqidrdq: Error: 1403 occured in OCI execute 2025-06-23 00:00:13.111511 :A8508921:db_trace:kwqid.c@2146:kwqidrdq(): [10960:31:249] kwqidrdq: Error: 1403 occured in OCI execute 2025-06-23 00:00:13.113945 :A8508922:db_trace:ktc.c@8711:ktcAutoTxnTrace(): [10441:31:249] atxpus:psdpgi.c:2235 2025-06-23 00:00:13.114279 :A8508923:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-23 00:00:13.114319 :A8508926:db_trace:ktc.c@8711:ktcAutoTxnTrace(): [10441:31:249] atxpop:psdpgi.c:2235 2025-06-23 00:00:13.117181 :A850892C:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-23 00:00:13.117949 :A8508934:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-23 00:00:13.119501 :A850893C:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-23 00:00:13.123740 :A8508944:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-23 00:00:13.127246 :A850894C:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-23 00:00:13.131258 :A8508954:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-23 00:00:13.135311 :A850895C:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-23 00:00:13.135898 :A8508964:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-23 00:00:13.140852 :A850896C:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-23 00:00:13.141116 :A8508974:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-23 00:00:13.141392 :A850897C:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=16 loc='ktm.h LINE:583 ID:ktmpsm' id1=0 id2=0 name= type=0 2025-06-23 00:00:13.145114 :A85089B4:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-23 00:00:13.145586 :A85089BC:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-23 00:00:13.149143 :A85089C4:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-23 00:00:13.150103 :A85089CC:db_trace:ktc.c@8711:ktcAutoTxnTrace(): [10441:31:249] atxpus:psdpgi.c:2235 2025-06-23 00:00:13.150409 :A85089CD:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-23 00:00:13.150438 :A85089D0:db_trace:ktc.c@8711:ktcAutoTxnTrace(): [10441:31:249] atxpop:psdpgi.c:2235 2025-06-23 00:00:13.150448 :A85089D1:db_trace:ktc.c@8711:ktcAutoTxnTrace(): [10441:31:249] atxpus:psdpgi.c:2235 2025-06-23 00:00:13.150583 :A85089D7:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-23 00:00:13.150600 :A85089DA:db_trace:ktc.c@8711:ktcAutoTxnTrace(): [10441:31:249] atxpop:psdpgi.c:2235 2025-06-23 00:00:13.150607 :A85089DB:db_trace:ktc.c@8711:ktcAutoTxnTrace(): [10441:31:249] atxpus:psdpgi.c:2235 2025-06-23 00:00:13.150706 :A85089E1:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-23 00:00:13.150722 :A85089E4:db_trace:ktc.c@8711:ktcAutoTxnTrace(): [10441:31:249] atxpop:psdpgi.c:2235 2025-06-23 00:00:13.150727 :A85089E5:db_trace:ktc.c@8711:ktcAutoTxnTrace(): [10441:31:249] atxpus:psdpgi.c:2235 2025-06-23 00:00:13.150821 :A85089EB:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-23 00:00:13.150837 :A85089EE:db_trace:ktc.c@8711:ktcAutoTxnTrace(): [10441:31:249] atxpop:psdpgi.c:2235 2025-06-23 00:00:13.150842 :A85089EF:db_trace:ktc.c@8711:ktcAutoTxnTrace(): [10441:31:249] atxpus:psdpgi.c:2235 2025-06-23 00:00:13.150939 :A85089F5:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-23 00:00:13.150955 :A85089F8:db_trace:ktc.c@8711:ktcAutoTxnTrace(): [10441:31:249] atxpop:psdpgi.c:2235 2025-06-23 00:00:13.150960 :A85089F9:db_trace:ktc.c@8711:ktcAutoTxnTrace(): [10441:31:249] atxpus:psdpgi.c:2235 2025-06-23 00:00:13.151064 :A85089FF:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-23 00:00:13.151080 :A8508A02:db_trace:ktc.c@8711:ktcAutoTxnTrace(): [10441:31:249] atxpop:psdpgi.c:2235 2025-06-23 00:00:13.151615 :A8508A08:db_trace:ktc.c@8711:ktcAutoTxnTrace(): [10441:31:249] atxpus:psdpgi.c:2235 2025-06-23 00:00:13.151734 :A8508A09:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-23 00:00:13.151753 :A8508A0C:db_trace:ktc.c@8711:ktcAutoTxnTrace(): [10441:31:249] atxpop:psdpgi.c:2235 2025-06-23 00:00:13.155755 :A8508A12:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-23 00:00:13.155836 :A8508A15:db_trace:ktc.c@8711:ktcAutoTxnTrace(): [10441:31:249] atxpus:psdpgi.c:2235 2025-06-23 00:00:13.156091 :A8508A1B:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-23 00:00:13.156112 :A8508A1E:db_trace:ktc.c@8711:ktcAutoTxnTrace(): [10441:31:249] atxpop:psdpgi.c:2235 2025-06-23 00:00:13.159424 :A8508A24:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-23 00:00:13.160207 :A8508A2C:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-23 00:00:13.160830 :A8508A34:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-23 00:00:13.161717 :A8508A3C:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-23 00:00:13.162422 :A8508A44:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-23 00:00:13.163194 :A8508A4C:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-23 00:00:13.163741 :A8508A4F:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-23 00:00:13.164182 :A8508A61:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-23 00:00:13.164737 :A8508A69:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-23 00:00:13.165264 :A8508A71:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-23 00:00:13.165954 :A8508A79:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-23 00:00:13.166512 :A8508A81:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-23 00:00:13.166964 :A8508A89:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-23 00:00:13.169670 :A8508A91:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-23 00:00:13.170811 :A8508A99:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-23 00:00:13.171661 :A8508AA1:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-23 00:00:13.172240 :A8508AA9:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-23 00:00:13.172698 :A8508AB1:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-23 00:00:13.173219 :A8508AB9:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-23 00:00:13.173776 :A8508AC1:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-23 00:00:13.174485 :A8508AC9:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-23 00:00:13.175020 :A8508AD1:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-23 00:00:13.175457 :A8508AD9:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-23 00:00:13.177104 :A8508AE1:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-23 00:00:13.177705 :A8508AE9:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-23 00:00:13.178912 :A8508AF1:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-23 00:00:13.182623 :A8508AF9:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-23 00:00:13.183331 :A8508B01:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-23 00:00:13.184359 :A8508B09:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-23 00:00:13.184939 :A8508B11:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-23 00:00:13.185657 :A8508B19:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-23 00:00:13.186273 :A8508B21:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-23 00:00:13.187226 :A8508B29:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-23 00:00:13.187855 :A8508B31:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-23 00:00:13.188515 :A8508B39:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-23 00:00:13.189652 :A8508B41:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-23 00:00:13.189752 :A8508B49:db_trace:ktc.c@8711:ktcAutoTxnTrace(): [10441:31:249] atxpus:psdpgi.c:2235 2025-06-23 00:00:13.190042 :A8508B4A:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-23 00:00:13.190073 :A8508B4D:db_trace:ktc.c@8711:ktcAutoTxnTrace(): [10441:31:249] atxpop:psdpgi.c:2235 2025-06-23 00:00:13.192389 :A8508B53:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-23 00:00:13.192546 :A8508B5C:db_trace:ksl2.c@12699:ksliwat(): [10005:31:249] KSL POST RCVD poster=14 loc='ksl2.h LINE:2165 ID:kslpsr' id1=134 id2=0 name=EV type=0 fac#=0 facpost=1 2025-06-23 00:00:43.267352 :A850969C:db_trace:kst.c@698:kstpsodel(): [10280:31:0] kst: process state object about to be deleted 2025-06-23 01:00:27.350533 :A85538EF:db_trace:kst.c@673:kstipg(): [10280:31:0] kst: process state object created on 06-23 01:00:27.348 2025-06-23 01:00:27.350535 :A85538F0:db_trace:kst.c@679:kstipg(): [10280:31:0] kst: process info: ospid=17600 pso_num=31 pso_serial#=44 2025-06-23 01:00:27.350691 :A85538F1:db_trace:kso.c@4093:ksonfy(): [10420:31:0] kso: new process: pid=17600 osp_idx=29 osp_ver=553 osp_pg=0 (spawn #312926) 2025-06-23 01:00:27.350691 :A85538F2:db_trace:kso.c@4099:ksonfy(): [10420:31:0] kso: new process: first_req_pid=3704 spawner_pid=3660 sga_crt_ts=x8A8A 2025-06-23 01:00:27.350692 :A85538F3:db_trace:kso.c@4103:ksonfy(): [10420:31:0] kso: new process: pso_index=31 reservation=172 time=3616170532 2025-06-23 01:00:27.350693 :A85538F4:db_trace:kso.c@4109:ksonfy(): [10420:31:0] kso: spawn diagnostics: queue time=0 secs 2025-06-23 01:00:27.350693 :A85538F5:db_trace:kso.c@4111:ksonfy(): [10420:31:0] kso: spawn diagnostics: fork time=0 secs 2025-06-23 01:00:27.350693 :A85538F6:db_trace:kso.c@4113:ksonfy(): [10420:31:0] kso: spawn diagnostics: exec time=0 secs 2025-06-23 01:00:27.350694 :A85538F7:db_trace:kso.c@4115:ksonfy(): [10420:31:0] kso: spawn diagnostics: pre dbkc time=0 secs 2025-06-23 01:00:27.350694 :A85538F8:db_trace:kso.c@4117:ksonfy(): [10420:31:0] kso: spawn diagnostics: post dbkc time=0 secs 2025-06-23 01:00:27.351209 :A85538F9:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=18 loc='kso2.h LINE:416 ID:ksoreq_reply' id1=0 id2=0 name= type=0 2025-06-23 01:00:27.351255 :A85538FF:db_trace:ksl2.c@12699:ksliwat(): [10005:31:249] KSL POST RCVD poster=18 loc='ksv2.h LINE:1639 ID:ksvpst: run' id1=0 id2=0 name= type=0 fac#=0 facpost=1 2025-06-23 01:00:27.359471 :A8553911:db_trace:kst.c@698:kstpsodel(): [10280:31:0] kst: process state object about to be deleted 2025-06-23 22:00:02.080382 :A8B8BD04:db_trace:kst.c@673:kstipg(): [10280:31:0] kst: process state object created on 06-23 22:00:02.076 2025-06-23 22:00:02.080384 :A8B8BD05:db_trace:kst.c@679:kstipg(): [10280:31:0] kst: process info: ospid=17696 pso_num=31 pso_serial#=45 2025-06-23 22:00:02.080516 :A8B8BD15:db_trace:kso.c@4093:ksonfy(): [10420:31:0] kso: new process: pid=17696 osp_idx=29 osp_ver=554 osp_pg=0 (spawn #315847) 2025-06-23 22:00:02.080517 :A8B8BD16:db_trace:kso.c@4099:ksonfy(): [10420:31:0] kso: new process: first_req_pid=4308 spawner_pid=3660 sga_crt_ts=x8A8A 2025-06-23 22:00:02.080517 :A8B8BD17:db_trace:kso.c@4103:ksonfy(): [10420:31:0] kso: new process: pso_index=31 reservation=173 time=3691745250 2025-06-23 22:00:02.080518 :A8B8BD18:db_trace:kso.c@4109:ksonfy(): [10420:31:0] kso: spawn diagnostics: queue time=0 secs 2025-06-23 22:00:02.080519 :A8B8BD19:db_trace:kso.c@4111:ksonfy(): [10420:31:0] kso: spawn diagnostics: fork time=0 secs 2025-06-23 22:00:02.080519 :A8B8BD1A:db_trace:kso.c@4113:ksonfy(): [10420:31:0] kso: spawn diagnostics: exec time=0 secs 2025-06-23 22:00:02.080519 :A8B8BD1B:db_trace:kso.c@4115:ksonfy(): [10420:31:0] kso: spawn diagnostics: pre dbkc time=0 secs 2025-06-23 22:00:02.080520 :A8B8BD1C:db_trace:kso.c@4117:ksonfy(): [10420:31:0] kso: spawn diagnostics: post dbkc time=0 secs 2025-06-23 22:00:02.081080 :A8B8BD1F:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=59 loc='kso2.h LINE:416 ID:ksoreq_reply' id1=0 id2=0 name= type=0 2025-06-23 22:00:32.159015 :A8B8D204:db_trace:kst.c@698:kstpsodel(): [10280:31:0] kst: process state object about to be deleted 2025-06-23 23:59:18.096936 :A8C23539:db_trace:kst.c@673:kstipg(): [10280:31:0] kst: process state object created on 06-23 23:59:18.095 2025-06-23 23:59:18.096938 :A8C2353A:db_trace:kst.c@679:kstipg(): [10280:31:0] kst: process info: ospid=11420 pso_num=31 pso_serial#=46 2025-06-23 23:59:18.097078 :A8C2353B:db_trace:kso.c@4070:ksonfy(): [10420:31:0] kso: new process: pid=11420 (legacy spawn) 2025-06-23 23:59:18.111281 :A8C2353C:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-23 23:59:51.276256 :A8C241B3:db_trace:kst.c@698:kstpsodel(): [10280:31:0] kst: process state object about to be deleted 2025-06-23 23:59:54.895443 :A8C242F3:db_trace:kst.c@673:kstipg(): [10280:31:0] kst: process state object created on 06-23 23:59:54.881 2025-06-23 23:59:54.895445 :A8C242F4:db_trace:kst.c@679:kstipg(): [10280:31:0] kst: process info: ospid=15368 pso_num=31 pso_serial#=47 2025-06-23 23:59:54.895583 :A8C242F5:db_trace:kso.c@4070:ksonfy(): [10420:31:0] kso: new process: pid=15368 (legacy spawn) 2025-06-23 23:59:54.909393 :A8C242F6:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-24 00:00:28.080027 :A8C251C4:db_trace:kst.c@698:kstpsodel(): [10280:31:0] kst: process state object about to be deleted 2025-06-24 22:00:00.153173 :A92A7555:db_trace:kst.c@673:kstipg(): [10280:31:0] kst: process state object created on 06-24 22:00:00.144 2025-06-24 22:00:00.153174 :A92A7556:db_trace:kst.c@679:kstipg(): [10280:31:0] kst: process info: ospid=17500 pso_num=31 pso_serial#=48 2025-06-24 22:00:00.153295 :A92A755C:db_trace:kso.c@4093:ksonfy(): [10420:31:0] kso: new process: pid=17500 osp_idx=29 osp_ver=557 osp_pg=0 (spawn #319174) 2025-06-24 22:00:00.153296 :A92A755D:db_trace:kso.c@4099:ksonfy(): [10420:31:0] kso: new process: first_req_pid=4308 spawner_pid=3660 sga_crt_ts=x8A8A 2025-06-24 22:00:00.153296 :A92A755E:db_trace:kso.c@4103:ksonfy(): [10420:31:0] kso: new process: pso_index=31 reservation=174 time=3778143344 2025-06-24 22:00:00.153297 :A92A755F:db_trace:kso.c@4109:ksonfy(): [10420:31:0] kso: spawn diagnostics: queue time=0 secs 2025-06-24 22:00:00.153297 :A92A7560:db_trace:kso.c@4111:ksonfy(): [10420:31:0] kso: spawn diagnostics: fork time=0 secs 2025-06-24 22:00:00.153297 :A92A7561:db_trace:kso.c@4113:ksonfy(): [10420:31:0] kso: spawn diagnostics: exec time=0 secs 2025-06-24 22:00:00.153297 :A92A7562:db_trace:kso.c@4115:ksonfy(): [10420:31:0] kso: spawn diagnostics: pre dbkc time=0 secs 2025-06-24 22:00:00.153298 :A92A7563:db_trace:kso.c@4117:ksonfy(): [10420:31:0] kso: spawn diagnostics: post dbkc time=0 secs 2025-06-24 22:00:00.153882 :A92A7564:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=59 loc='kso2.h LINE:416 ID:ksoreq_reply' id1=0 id2=0 name= type=0 2025-06-24 22:00:30.296813 :A92A881D:db_trace:kst.c@698:kstpsodel(): [10280:31:0] kst: process state object about to be deleted 2025-06-24 23:59:15.974406 :A933C85F:db_trace:kst.c@673:kstipg(): [10280:31:0] kst: process state object created on 06-24 23:59:15.962 2025-06-24 23:59:15.974408 :A933C860:db_trace:kst.c@679:kstipg(): [10280:31:0] kst: process info: ospid=16132 pso_num=31 pso_serial#=49 2025-06-24 23:59:15.974535 :A933C861:db_trace:kso.c@4070:ksonfy(): [10420:31:0] kso: new process: pid=16132 (legacy spawn) 2025-06-24 23:59:15.981242 :A933C862:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-24 23:59:15.981419 :A933C86A:db_trace:ksl2.c@12699:ksliwat(): [10005:31:249] KSL POST RCVD poster=14 loc='ksl2.h LINE:2165 ID:kslpsr' id1=134 id2=0 name=EV type=0 fac#=0 facpost=1 2025-06-24 23:59:15.982227 :A933C86B:db_trace:kst.c@698:kstpsodel(): [10280:31:0] kst: process state object about to be deleted 2025-06-24 23:59:15.991131 :A933C86E:db_trace:kst.c@673:kstipg(): [10280:31:0] kst: process state object created on 06-24 23:59:15.977 2025-06-24 23:59:15.991133 :A933C86F:db_trace:kst.c@679:kstipg(): [10280:31:0] kst: process info: ospid=15304 pso_num=31 pso_serial#=50 2025-06-24 23:59:15.991279 :A933C870:db_trace:kso.c@4070:ksonfy(): [10420:31:0] kso: new process: pid=15304 (legacy spawn) 2025-06-24 23:59:15.997917 :A933C871:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-24 23:59:15.998084 :A933C87A:db_trace:ksl2.c@12699:ksliwat(): [10005:31:249] KSL POST RCVD poster=14 loc='ksl2.h LINE:2165 ID:kslpsr' id1=134 id2=0 name=EV type=0 fac#=0 facpost=1 2025-06-24 23:59:15.998905 :A933C87B:db_trace:kst.c@698:kstpsodel(): [10280:31:0] kst: process state object about to be deleted 2025-06-24 23:59:16.456153 :A933C8EB:db_trace:kst.c@673:kstipg(): [10280:31:0] kst: process state object created on 06-24 23:59:16.446 2025-06-24 23:59:16.456155 :A933C8EC:db_trace:kst.c@679:kstipg(): [10280:31:0] kst: process info: ospid=14500 pso_num=31 pso_serial#=51 2025-06-24 23:59:16.456301 :A933C8ED:db_trace:kso.c@4070:ksonfy(): [10420:31:0] kso: new process: pid=14500 (legacy spawn) 2025-06-24 23:59:16.463433 :A933C8EE:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-24 23:59:16.463620 :A933C8F6:db_trace:ksl2.c@12699:ksliwat(): [10005:31:249] KSL POST RCVD poster=14 loc='ksl2.h LINE:2165 ID:kslpsr' id1=134 id2=0 name=EV type=0 fac#=0 facpost=1 2025-06-24 23:59:16.464665 :A933C8F8:db_trace:kst.c@698:kstpsodel(): [10280:31:0] kst: process state object about to be deleted 2025-06-24 23:59:18.033600 :A933C95B:db_trace:kst.c@673:kstipg(): [10280:31:0] kst: process state object created on 06-24 23:59:18.027 2025-06-24 23:59:18.033603 :A933C95C:db_trace:kst.c@679:kstipg(): [10280:31:0] kst: process info: ospid=12372 pso_num=31 pso_serial#=52 2025-06-24 23:59:18.033738 :A933C95D:db_trace:kso.c@4070:ksonfy(): [10420:31:0] kso: new process: pid=12372 (legacy spawn) 2025-06-24 23:59:18.050211 :A933C95E:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-24 23:59:51.362846 :A933D5DE:db_trace:kst.c@698:kstpsodel(): [10280:31:0] kst: process state object about to be deleted 2025-06-24 23:59:52.197138 :A933D61B:db_trace:kst.c@673:kstipg(): [10280:31:0] kst: process state object created on 06-24 23:59:52.188 2025-06-24 23:59:52.197140 :A933D61C:db_trace:kst.c@679:kstipg(): [10280:31:0] kst: process info: ospid=13792 pso_num=31 pso_serial#=53 2025-06-24 23:59:52.197289 :A933D61D:db_trace:kso.c@4070:ksonfy(): [10420:31:0] kso: new process: pid=13792 (legacy spawn) 2025-06-24 23:59:52.203930 :A933D61E:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-24 23:59:52.204102 :A933D627:db_trace:ksl2.c@12699:ksliwat(): [10005:31:249] KSL POST RCVD poster=14 loc='ksl2.h LINE:2165 ID:kslpsr' id1=134 id2=0 name=EV type=0 fac#=0 facpost=1 2025-06-24 23:59:52.204916 :A933D628:db_trace:kst.c@698:kstpsodel(): [10280:31:0] kst: process state object about to be deleted 2025-06-24 23:59:52.213622 :A933D62B:db_trace:kst.c@673:kstipg(): [10280:31:0] kst: process state object created on 06-24 23:59:52.204 2025-06-24 23:59:52.213624 :A933D62C:db_trace:kst.c@679:kstipg(): [10280:31:0] kst: process info: ospid=16372 pso_num=31 pso_serial#=54 2025-06-24 23:59:52.213759 :A933D62D:db_trace:kso.c@4070:ksonfy(): [10420:31:0] kso: new process: pid=16372 (legacy spawn) 2025-06-24 23:59:52.220219 :A933D62E:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-24 23:59:52.220387 :A933D636:db_trace:ksl2.c@12699:ksliwat(): [10005:31:249] KSL POST RCVD poster=14 loc='ksl2.h LINE:2165 ID:kslpsr' id1=134 id2=0 name=EV type=0 fac#=0 facpost=1 2025-06-24 23:59:52.221204 :A933D637:db_trace:kst.c@698:kstpsodel(): [10280:31:0] kst: process state object about to be deleted 2025-06-24 23:59:54.870039 :A933D71D:db_trace:kst.c@673:kstipg(): [10280:31:0] kst: process state object created on 06-24 23:59:54.866 2025-06-24 23:59:54.870040 :A933D71E:db_trace:kst.c@679:kstipg(): [10280:31:0] kst: process info: ospid=17740 pso_num=31 pso_serial#=55 2025-06-24 23:59:54.870166 :A933D71F:db_trace:kso.c@4070:ksonfy(): [10420:31:0] kso: new process: pid=17740 (legacy spawn) 2025-06-24 23:59:54.884598 :A933D733:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=14 loc='ksa2.h LINE:282 ID:ksasnd' id1=0 id2=0 name= type=0 2025-06-25 00:00:28.155240 :A933E2C3:db_trace:kst.c@698:kstpsodel(): [10280:31:0] kst: process state object about to be deleted 2025-06-25 22:00:02.045011 :A99B94F2:db_trace:kst.c@673:kstipg(): [10280:31:0] kst: process state object created on 06-25 22:00:02.037 2025-06-25 22:00:02.045012 :A99B94F3:db_trace:kst.c@679:kstipg(): [10280:31:0] kst: process info: ospid=17724 pso_num=31 pso_serial#=56 2025-06-25 22:00:02.045144 :A99B94F4:db_trace:kso.c@4093:ksonfy(): [10420:31:0] kso: new process: pid=17724 osp_idx=29 osp_ver=565 osp_pg=0 (spawn #322493) 2025-06-25 22:00:02.045145 :A99B94F5:db_trace:kso.c@4099:ksonfy(): [10420:31:0] kso: new process: first_req_pid=4308 spawner_pid=3660 sga_crt_ts=x8A8A 2025-06-25 22:00:02.045145 :A99B94F6:db_trace:kso.c@4103:ksonfy(): [10420:31:0] kso: new process: pso_index=31 reservation=175 time=3864545235 2025-06-25 22:00:02.045146 :A99B94F7:db_trace:kso.c@4109:ksonfy(): [10420:31:0] kso: spawn diagnostics: queue time=0 secs 2025-06-25 22:00:02.045146 :A99B94F8:db_trace:kso.c@4111:ksonfy(): [10420:31:0] kso: spawn diagnostics: fork time=0 secs 2025-06-25 22:00:02.045147 :A99B94F9:db_trace:kso.c@4113:ksonfy(): [10420:31:0] kso: spawn diagnostics: exec time=0 secs 2025-06-25 22:00:02.045147 :A99B94FA:db_trace:kso.c@4115:ksonfy(): [10420:31:0] kso: spawn diagnostics: pre dbkc time=0 secs 2025-06-25 22:00:02.045147 :A99B94FB:db_trace:kso.c@4117:ksonfy(): [10420:31:0] kso: spawn diagnostics: post dbkc time=0 secs 2025-06-25 22:00:02.045649 :A99B94FD:db_trace:ksl2.c@14083:ksl_update_post_stats(): [10005:31:249] KSL POST SENT postee=59 loc='kso2.h LINE:416 ID:ksoreq_reply' id1=0 id2=0 name= type=0 ------------------------------------------------------------------------------- Trace Bucket Dump End: default bucket for process 31 (osid: 17724, J005)