Wed Dec 21 22:30:19 2011
Time drift detected. Please check VKTM trace file for more details.
Wed Dec 21 23:30:21 2011
Time drift detected. Please check VKTM trace file for more details.
Thu Dec 22 00:30:22 2011
Time drift detected. Please check VKTM trace file for more details.
Thu Dec 22 01:30:23 2011
Time drift detected. Please check VKTM trace file for more details.
Thu Dec 22 02:30:24 2011
Time drift detected. Please check VKTM trace file for more details.
Thu Dec 22 03:30:25 2011
Time drift detected. Please check VKTM trace file for more details.
Thu Dec 22 04:30:26 2011
Time drift detected. Please check VKTM trace file for more details.
Thu Dec 22 05:30:27 2011
Time drift detected. Please check VKTM trace file for more details.
Thu Dec 22 06:03:11 2011
RFS[4]: Selected log 5 for thread 1 sequence 121 dbid 2107288066 branch 770032517
Thu Dec 22 06:03:11 2011
Media Recovery Waiting for thread 1 sequence 121 (in transit)
Recovery of Online Redo Log: Thread 1 Group 5 Seq 121 Reading mem 0
Mem# 0: /u01/product/oradata/wmsdb/standby_log5.log
Thu Dec 22 06:03:11 2011
Archived Log entry 22 added for thread 1 sequence 120 ID 0x7d9a3902 dest 1:
Thu Dec 22 06:30:28 2011
Time drift detected. Please check VKTM trace file for more details.
Thu Dec 22 07:30:30 2011
Time drift detected. Please check VKTM trace file for more details.
Thu Dec 22 08:30:31 2011
Time drift detected. Please check VKTM trace file for more details.
Thu Dec 22 09:30:32 2011
Time drift detected. Please check VKTM trace file for more details.
看Trace文件,發現和Bug 11837095: "TIME DRIFT DETECTED" APPEARS INTERMITTENTLY IN ALERT LOG, THO' EVENT 10795 SET相當像
| Bug 11837095: "TIME DRIFT DETECTED" APPEARS INTERMITTENTLY IN ALERT LOG, THO' EVENT 10795 SET | |||||
| [hr] | |||||
 Bug 属性
        Bug 属性[hr]
| 类型 | B - Defect | 已在产品版本中修复 | - | 
| 严重性 | 2 - Severe Loss of Service | 产品版本 | 11.2.0.2 | 
| 状态 | 11 - Code Bug (Response/Resolution) | 平台 | 226 - Linux x86-64 | 
| 创建时间 | 04-Mar-2011 | 平台版本 | NO DATA | 
| 更新时间 | 08-Dec-2011 | 基本 Bug | - | 
| 数据库版本 | 11.2.0.2 |  | |
| 影响平台 | Generic |  | |
| 产品源 | Oracle |  | 
 相关产品
       相关产品[hr]
| 产品线 | Oracle Database Products | 系列 | Oracle Database | 
| 区域 | Oracle Database | 产品 | 5 - Oracle Server - Enterprise Edition | 
Abstract: "TIME DRIFT DETECTED" APPEARS INTERMITTENTLY IN ALERT LOG, THO' EVENT 10795 SET
*** 03/04/11 02:59 pm ***
*** 03/06/11 05:10 pm ***
*** 03/06/11 05:50 pm *** (CHG: Sta->11)
*** 03/06/11 05:50 pm ***
*** 03/06/11 05:50 pm ***
*** 03/06/11 05:50 pm ***
*** 04/17/11 05:55 pm ***
*** 04/19/11 08:36 pm ***
*** 05/10/11 03:57 am ***
*** 05/11/11 07:38 am ***
*** 05/11/11 07:38 am ***
*** 05/12/11 11:08 am ***
*** 05/12/11 11:08 am ***
*** 05/16/11 06:01 am ***
*** 08/02/11 06:35 am ***
*** 08/02/11 07:33 am ***
*** 08/02/11 08:20 pm ***
*** 08/03/11 12:40 am ***
Thanks a lot for your update, Much appreciated.
*** 09/01/11 09:28 pm ***
*** 10/28/11 02:38 am ***
*** 11/15/11 04:36 am ***
*** 11/15/11 04:38 am ***
*** 11/15/11 04:38 am ***
*** 11/15/11 04:38 am ***
*** 11/15/11 05:23 am ***
*** 11/15/11 05:23 am ***
*** 11/18/11 05:59 am ***
*** 12/08/11 09:41 am ***
 返回页首
返回页首這個Bug沒有帶Trace文件,而Windows 64 Bit平台下另外一個Bug 13260973: TIME DRIFT DETECED IN ALERT.LOG WITH EVENT 10795 ENABLED
與它相關聯,Trace文件能對起來
| Bug 13260973: TIME DRIFT DETECED IN ALERT.LOG WITH EVENT 10795 ENABLED | |||||
| [hr] | |||||
 Bug 属性
        Bug 属性[hr]
| 类型 | B - Defect | 已在产品版本中修复 | - | 
| 严重性 | 2 - Severe Loss of Service | 产品版本 | 11.2.0.2 | 
| 状态 | 36 - Duplicate Bug. To Filer | 平台 | 233 - Microsoft Windows x64 (64-bit) | 
| 创建时间 | 27-Oct-2011 | 平台版本 | 2008 R2 | 
| 更新时间 | 24-Nov-2011 | 基本 Bug | 11837095 | 
| 数据库版本 | 11.2.0.2 |  | |
| 影响平台 | Generic |  | |
| 产品源 | Oracle |  | 
 相关产品
       相关产品[hr]
| 产品线 | Oracle Database Products | 系列 | Oracle Database | 
| 区域 | Oracle Database | 产品 | 5 - Oracle Server - Enterprise Edition | 
Abstract: TIME DRIFT DETECED IN ALERT.LOG WITH EVENT 10795 ENABLED
*** 10/27/11 03:50 am ***
BUG TYPE CHOSEN
===============
Code
SubComponent: VOS Compile Time Services
=======================================
DETAILED PROBLEM DESCRIPTION
============================
Found the following in the alert log file :
Time drift detected. Please check VKTM trace file for more details.
Trace file is filled with the following:
kstmmainvktm: succeeded in setting elevated priority
highres_enabled
*** 2011-03-01 17:19:29.321
VKTM running at (10)millisec precision with DBRM quantum (100)ms
[Start] HighResTick = 248456066
kstmrmtickcnt = 0 : ksudbrmseccnt[0] = 1298996369
kstmchkdrift (kstmhighrestimecntkeeper:lowres): Time stalled at 1299001603
*** 2011-03-01 18:46:45.001
kstmchkdrift (kstmhighrestimecntkeeper:lowres): Stall, backward drift ended
at 1299001605 drift: 2
kstmchkdrift (kstmhighrestimecntkeeper:lowres): Time stalled at 1299078529
DIAGNOSTIC ANALYSIS
===================
Performed the following to set the parameter:
alter system set event="10795 trace name context forever, level 2"
scope=spfile;
then shutdown and startup the database.
However, the error message and trace files are still being generated.
WORKAROUND?
===========
No
TECHNICAL IMPACT
================
Trace files consume disk space
RELATED ISSUES (bugs, forums, RFAs)
===================================
Bug 11837095 - "TIME DRIFT DETECTED" APPEARS INTERMITTENTLY IN ALERT LOG,
THO' EVENT 10795 SET
HOW OFTEN DOES THE ISSUE REPRODUCE AT CUSTOMER SITE?
====================================================
Always
DOES THE ISSUE REPRODUCE INTERNALLY?
====================================
Not attempted
EXPLAIN WHY THE ISSUE WAS NOT TESTED INTERNALLY.
================================================
Not Feasible.
Not sure how can it be reproduced in-house
IS A TESTCASE AVAILABLE?
========================
No
Link to IPS Package:
====================
not available
*** 10/27/11 05:28 am ***
*** 10/27/11 05:41 am ***
*** 10/27/11 05:41 am *** (CHG: Sta->10)
*** 10/27/11 05:41 am ***
*** 10/28/11 02:18 am *** (CHG: Sta->16)
*** 10/28/11 02:18 am ***
*** 10/28/11 02:36 am ***
*** 10/28/11 02:38 am *** (CHG: Base Bug-> NULL -> 11837095)
*** 10/28/11 02:38 am *** (CHG: Sta->11)
*** 10/28/11 02:38 am ***
*** 10/28/11 02:38 am ***
*** 10/28/11 02:38 am ***
*** 11/21/11 02:17 am ***
*** 11/21/11 02:17 am ***
*** 11/24/11 12:41 am ***
*** 11/24/11 12:45 am *** (CHG: Sta->36)
*** 11/24/11 12:45 am ***
 返回页首
返回页首看metalink上另外一個Solaris X86-64Bit下的 Bug 13371247: TIME DRIFT DETECTED. PLEASE CHECK VKTM TRACE FILE FOR MORE DETAILS
說設置10795事件只能屏蔽掉trace文件的生成,Bug 13371247又與Bug 13260973類似
event="10795 trace name context forever, level 2"
Oracle對VKTM後台進程解釋如下:
VKTM (virtual keeper of time) is responsible for providing a wall-clock time
(updated every second) and reference-time counter (updated every 20 ms and
available only when running at elevated priority).
猜測這個Bug可能是在所有平台上都有,而我們的機器每到整點與半點就與NTP Server對時,有可能Time Difference差異大,所以觸發這個Bug
在Alert中這個錯誤信息出現的相當有規律,每到半點就報一次,暫時改一下crontab排程,改成15分鐘對一次時再繼續觀察