Re: ORA-00600: internal error code, arguments: [3708], [910]

vale77 wrote:
> > * When do you see the ORA-600 - at start up, after sessions connect,
> > some other time? Is there more information in a trace file?
> > * Why do you have "event = 16155 trace name context forever, level 1"
> > * log_buffer = 15728640 - a 15MB log buffer on Oracle 8i?
> > * processes = 50, sessions = 335 - processes and sessions should be
> > close to the same number.
> > * parallel_server = FALSE, parallel_min_servers = 10,
> > parallel_max_servers = 150 - Is there something wrong here?
> >
> > Charles Hooper
> > PC Support Specialist
> > K&M Machine-Fabricating, Inc.
>
>
> thanks for ready answer
> ok, now i post more info
> oracle instance is on HP-UX server, it fails on startup fase
>
> this event=16155 is set to prevent a bug on oracle 8i, that can exceed
> max number of archiver processes
> log_buffer =15 mb, where is the problem?
> sessions = 335 and parallel_server =false it's our mistake, now we
> retry to open..
>
> Dump file is so
> *** 2007-01-19 12:47:00.927
> *** SESSION ID:(8.3) 2007-01-19 12:47:00.855
> ===================================================
> SYSTEM STATE
> ------------
> System global information:
> Number of NUMA instances : 1
> processes: base d8e6f4f0, size 50, cleanup d8e6fbf0
> allocation: free sessions(0) d8e81b80, free calls(0) 2
> control alloc errors: 0 (process), 0 (session), 0 (call)
> system statistics:
> 0 9 logons cumulative
> 0 8 logons current
> 0 10 opened cursors cumulative
> 0 2 opened cursors current
> 0 0 user commits
> 0 0 user rollbacks
> 0 32 user calls
> 0 12 recursive calls
> 0 2 recursive cpu usage
> 0 0 session logical reads
> 0 0 session stored procedure space
> 0 12 CPU used when call started
> 0 12 CPU used by this session
> 0 0 session connect time
> 0 0 process last non-idle time
> 0 161508 session uga memory
> 0 181180 session uga memory max
> 0 8 messages sent
> 0 8 messages received
> 0 1045 background timeouts
> 0 12986072 session pga memory
> 0 12986072 session pga memory max
> 0 0 enqueue timeouts
> 0 0 enqueue waits
> 0 0 enqueue deadlocks
> 0 464 enqueue requests
> 0 0 enqueue conversions
> 0 245 enqueue releases
> 0 0 global lock sync gets
> 0 0 global lock async gets
> 0 0 global lock get time
> 0 0 global lock sync converts
> 0 0 global lock async converts
> 0 0 global lock convert time
> 0 0 global lock releases
> 0 908 total file opens
> 0 0 opens requiring cache replacement
> 0 0 opens of replaced files
> 0 0 db block gets
> 0 0 consistent gets
> 0 645 physical reads
> 0 0 db block changes
> 0 0 consistent changes
> 0 0 recovery blocks read
> 0 17 physical writes
> 0 17 physical writes non checkpoint
> 0 0 summed dirty queue length
> 0 0 DBWR checkpoint buffers written
> 0 0 DBWR transaction table writes
> 0 0 DBWR undo block writes
> 0 0 DBWR revisited being-written buffer
> 0 0 DBWR make free requests
> 0 0 DBWR free buffers found
> 0 0 DBWR lru scans
> 0 0 DBWR summed scan depth
> 0 0 DBWR buffers scanned
> 0 0 DBWR checkpoints
> 0 0 DBWR cross instance writes
> 0 0 remote instance undo block writes
> 0 0 remote instance undo header writes
> 0 0 change write time
> 0 0 redo synch writes
> 0 0 redo synch time
> 0 0 exchange deadlocks
> 0 0 free buffer requested
> 0 0 dirty buffers inspected
> 0 0 pinned buffers inspected
> 0 0 hot buffers moved to head of LRU
> 0 0 free buffer inspected
> 0 0 commit cleanout failures: write disabled
> 0 0 commit cleanout failures: block lost
> 0 0 commit cleanout failures: cannot pin
> 0 0 commit cleanout failures: hot backup in progress
> 0 0 commit cleanout failures: buffer being written
> 0 0 commit cleanout failures: callback failure
> 0 0 commit cleanouts
> 0 0 commit cleanouts successfully completed
> 0 0 recovery array reads
> 0 0 recovery array read time
> 0 0 CR blocks created
> 0 0 current blocks converted for CR
> 0 0 switch current to new buffer
> 0 0 write clones created in foreground
> 0 0 write clones created in background
> 0 0 prefetched blocks
> 0 0 prefetched blocks aged out before use
> 0 645 physical reads direct
> 0 17 physical writes direct
> 0 0 physical reads direct (lob)
> 0 0 physical writes direct (lob)
> 0 0 cold recycle reads
> 0 0 calls to kcmgcs
> 0 0 calls to kcmgrs
> 0 1 calls to kcmgas
> 0 0 next scns gotten without going to DLM
> 0 0 Unnecesary process cleanup for SCN batching
> 0 0 calls to get snapshot scn: kcmgss
> 0 0 kcmgss waited for batching
> 0 0 kcmgss read scn without going to DLM
> 0 0 kcmccs called get current scn
> 0 0 redo entries
> 0 0 redo size
> 0 0 redo buffer allocation retries
> 0 0 redo wastage
> 0 0 redo writer latching time
> 0 0 redo writes
> 0 0 redo blocks written
> 0 0 redo write time
> 0 0 redo log space requests
> 0 0 redo log space wait time
> 0 0 redo log switch interrupts
> 0 0 redo ordering marks
> 0 0 global cache gets
> 0 0 global cache get time
> 0 0 global cache converts
> 0 0 global cache convert time
> 0 0 global cache cr blocks received
> 0 0 global cache cr block receive time
> 0 0 global cache read buffer blocks received
> 0 0 global cache read buffer block receive time
> 0 0 global cache cr blocks served
> 0 0 global cache cr block build time
> 0 0 global cache cr block flush time
> 0 0 global cache cr block send time
> 0 0 global cache read buffer blocks served
> 0 0 global cache read buffer block build time
> 0 0 global cache read buffer block send time
> 0 0 global cache freelist waits
> 0 0 global cache defers
> 0 0 global cache convert timeouts
> 0 0 global cache cr timeouts
> 0 0 global cache read buffer lock timeouts
> 0 0 global cache read buffer block timeouts
> 0 0 global cache cr requests blocked
> 0 0 global cache blocks corrupt
> 0 0 global cache prepare failures
> 0 0 instance recovery database freeze count
> 0 0 background checkpoints started
> 0 0 background checkpoints completed
> 0 0 serializable aborts
> 0 0 transaction lock foreground requests
> 0 0 transaction lock foreground wait time
> 0 0 transaction lock background gets
> 0 0 transaction lock background get time
> 0 0 transaction tables consistent reads - undo
> records applied
> 0 0 transaction tables consistent read rollbacks
> 0 0 data blocks consistent reads - undo records
> applied
> 0 0 no work - consistent read gets
> 0 0 cleanouts only - consistent read gets
> 0 0 rollbacks only - consistent read gets
> 0 0 cleanouts and rollbacks - consistent read gets
> 0 0 rollback changes - undo records applied
> 0 0 transaction rollbacks
> 0 0 immediate (CURRENT) block cleanout applications
> 0 0 immediate (CR) block cleanout applications
> 0 0 deferred (CURRENT) block cleanout applications
> 0 0 Commit SCN cached
> 0 0 Cached Commit SCN referenced
> 0 0 table scans (short tables)
> 0 0 table scans (long tables)
> 0 0 table scans (rowid ranges)
> 0 0 table scans (cache partitions)
> 0 0 table scans (direct read)
> 0 0 table scan rows gotten
> 0 0 table scan blocks gotten
> 0 0 table fetch by rowid
> 0 0 table fetch continued row
> 0 0 cluster key scans
> 0 0 cluster key scan block gets
> 0 0 rows fetched via callback
> 0 0 leaf node splits
> 0 0 branch node splits
> 0 0 native hash arithmetic execute
> 0 0 native hash arithmetic fail
> 0 0 index fast full scans (full)
> 0 0 index fast full scans (rowid ranges)
> 0 0 index fast full scans (direct read)
> 0 4 parse time cpu
> 0 109 parse time elapsed
> 0 9 parse count (total)
> 0 10 parse count (hard)
> 0 9 execute count
> 0 3369 bytes sent via SQL*Net to client
> 0 1999 bytes received via SQL*Net from client
> 0 20 SQL*Net roundtrips to/from client
> 0 0 bytes sent via SQL*Net to dblink
> 0 0 bytes received via SQL*Net from dblink
> 0 0 SQL*Net roundtrips to/from dblink
> 0 0 sorts (memory)
> 0 0 sorts (disk)
> 0 0 sorts (rows)
> 0 0 session cursor cache hits
> 0 0 session cursor cache count
> 0 0 cursor authentications
> 0 0 queries parallelized
> 0 0 DML statements parallelized
> 0 0 DDL statements parallelized
> 0 0 DFO trees parallelized
> 0 0 Parallel operations not downgraded
> 0 0 Parallel operations downgraded to serial
> 0 0 Parallel operations downgraded 75 to 99 pct
> 0 0 Parallel operations downgraded 50 to 75 pct
> 0 0 Parallel operations downgraded 25 to 50 pct
> 0 0 Parallel operations downgraded 1 to 25 pct
> 0 0 PX local messages sent
> 0 0 PX local messages recv'd
> 0 0 PX remote messages sent
> 0 0 PX remote messages recv'd
> 0 0 buffer is pinned count
> 0 0 buffer is not pinned count
> 0 0 no buffer to keep pinned count
> PROCESS 1:
> ----------------------------------------
> SO: d8e6f8d4, type: 1, owner: 0, pt: 0, flag: INIT/-/-/0x00
> (process) Oracle pid=1, calls cur/top: 0/0, flag: (10) PSEUDO
> int error: 0, call error: 0, sess error: 0, txn error 0
> (post info) last post received: 0 0 0
> last post received-location: No post
> last process to post me: none
> last post sent: 0 0 0
> last post sent-location: No post
> last process posted by me: none
> (latch info) wait_event=0 bits=0
> O/S info: user: , term: , ospid:
> OSD pid info: 0
> PROCESS 2:
> ----------------------------------------
> SO: d8e6fbf0, type: 1, owner: 0, pt: 0, flag: INIT/-/-/0x00
> (process) Oracle pid=2, calls cur/top: d8f2e928/d8f2e928, flag: (6)
> SYSTEM
> int error: 0, call error: 0, sess error: 0, txn error 0
> (post info) last post received: 0 0 27
> last post received-location: ksrpublish
> last process to post me: d8e711b4 2 0
> last post sent: 0 0 10
> last post sent-location: ksbrdp
> last process posted by me: d8e78e14 1 0
> (latch info) wait_event=0 bits=0
> Process Group: DEFAULT, pseudo proc: d8e792f0
> O/S info: user: oracle, term: UNKNOWN, ospid: 6054
> OSD pid info: 6054
> ----------------------------------------
> SO: d8fcd270, type: 9, owner: d8e6fbf0, pt: 0, flag: INIT/-/-/0x00
> (broadcast handle) flag: (2) ACTIVE SUBSCRIBER, owner: d8e6fbf0,
> event: 2, last message event: 9, messages read:
> 1
> channel: (d8fcd678) scumnt mount lock
> scope: 101, event: 9, last mesage
> event: 9,
> publishers/subscribers: 0/7,
> messages published: 1
> ----------------------------------------
> SO: d8e7cf90, type: 3, owner: d8e6fbf0, pt: 0, flag: INIT/-/-/0x00
> (session) trans: 0, creator: d8e6fbf0, flag: (51) USR/-
> BSY/-/-/-/-/-
> DID: 0000-0000-00000000, short-term DID:
> 0000-0000-00000000
> txn branch: 0
> oct: 0, prv: 0, user: 0/SYS
> waiting for 'pmon timer' blocking sess=0x0 seq=352 wait_time=0
> duration=12c, =0, =0
> ----------------------------------------
> SO: d8fcd3d8, type: 9, owner: d8e6fbf0, pt: 0, flag: INIT/-/-/0x00
> (broadcast handle) flag: (2) ACTIVE SUBSCRIBER, owner: d8e6fbf0,
> event: 2, last message event: 2, messages read:
> 0
> channel: (d8fcd588) system events broadcast
> channel
> scope: 101, event: 20, last mesage
> event: 0,
> publishers/subscribers: 0/18,
> messages published: 0
> ----------------------------------------
> SO: d8f2e928, type: 2, owner: d8e6fbf0, pt: 0, flag: INIT/-/-/0x00
> (call) sess: cur d8e7cf90, rec 0, usr d8e7cf90; depth: 0
> PROCESS 3:
> ----------------------------------------
> SO: d8e6ff0c, type: 1, owner: 0, pt: 0, flag: INIT/-/-/0x00
> (process) Oracle pid=3, calls cur/top: d8f2e8d8/d8f2e8d8, flag: (2)
> SYSTEM
> int error: 0, call error: 0, sess error: 0, txn error 0
> (post info) last post received: 0 0 13
> last post received-location: ksasnd
> last process to post me: d8e711b4 2 0
> last post sent: 0 0 14
> last post sent-location: ksasnr
> last process posted by me: d8e711b4 2 0
> (latch info) wait_event=0 bits=0
> Process Group: DEFAULT, pseudo proc: d8e792f0
> O/S info: user: oracle, term: UNKNOWN, ospid: 6056
> OSD pid info: 6056
> ----------------------------------------
> SO: d8fcd2e8, type: 9, owner: d8e6ff0c, pt: 0, flag: INIT/-/-/0x00
> (broadcast handle) flag: (2) ACTIVE SUBSCRIBER, owner: d8e6ff0c,
> event: 1, last message event: 9, messages read:
> 1
> channel: (d8fcd678) scumnt mount lock
> scope: 101, event: 9, last mesage
> event: 9,
> publishers/subscribers: 0/7,
> messages published: 1
> ----------------------------------------
> SO: d8e7d800, type: 3, owner: d8e6ff0c, pt: 0, flag: INIT/-/-/0x00
> (session) trans: 0, creator: d8e6ff0c, flag: (51) USR/-
> BSY/-/-/-/-/-
> DID: 0001-0003-00000003, short-term DID:
> 0000-0000-00000000
> txn branch: 0
> oct: 0, prv: 0, user: 0/SYS
> waiting for 'rdbms ipc message' blocking sess=0x0 seq=1446
> wait_time=0
> timeout=12c, =0, =0
> ----------------------------------------
> SO: d8fcd360, type: 9, owner: d8e6ff0c, pt: 0, flag: INIT/-/-/0x00
> (broadcast handle) flag: (2) ACTIVE SUBSCRIBER, owner: d8e6ff0c,
> event: 3, last message event: 3, messages read:
> 0
> channel: (d8fcd588) system events broadcast
> channel
> scope: 101, event: 20, last mesage
> event: 0,
> publishers/subscribers: 0/18,
> messages published: 0
> ----------------------------------------
> SO: d8f2e8d8, type: 2, owner: d8e6ff0c, pt: 0, flag: INIT/-/-/0x00
> (call) sess: cur d8e7d800, rec 0, usr d8e7d800; depth: 0
>
> -------------------------------------------------------------------------------------------------------------------------

Metalink notes 1921532.8, 178232.1 refer to 16155 trace. I did not have that trace event set when I was running 8.1.7.3, although I was not running Oracle on a Unix operating system.

Log_buffer = 15MB - performance tuning books ("Oracle Performance Tuning 101" by Gaja Vaidyanatha, and other books) essentially state that a log_buffer larger than 1MB is rarely useful.

processes = 335, sessions = 335 makes more sense than does processes = 50, sessions = 50

parallel_min_servers = 10 - seems rather high, unless the server has many CPUs.

You are limiting your log file size to 50 * db block size:   max_dump_file_size = 50

Once a full log file is obtained, and you have fixed the above, see if the following Metalink document applies:   Note:285991.1

There is an ORA-600 error lookup tool on Metalink.

Charles Hooper
PC Support Specialist
K&M Machine-Fabricating, Inc. Received on Fri Jan 19 2007 - 13:34:16 CST