본문 바로가기

WAS/WebLogic

WebLogic - 데이터소스 관련 각종 로그 (Connection Pool Max 등)

connection leak 시켜서 pool max 도달 시 로그
<Nov 27, 2019 9:46:10 AM KST> <Info> <Common> <BEA-000627> <Reached maximum capacity of pool "gtplus", making "0" new resource instances instead of "1".>


<Nov 27, 2019 9:44:12 AM KST> <Error> <HTTP> <BEA-101017> <[ServletContext@2035631937[app:testApp module:testApp path:/testApp spec-version:null]] Root cause of ServletException.
weblogic.jdbc.extensions.PoolLimitSQLException: weblogic.common.resourcepool.ResourceLimitException: No resources currently available in pool gtplus to allocate to applications, please increase the size of the pool and retry..
        at weblogic.jdbc.common.internal.JDBCUtil.wrapAndThrowResourceException(JDBCUtil.java:252)
        at weblogic.jdbc.pool.Driver.connect(Driver.java:142)
        at weblogic.jdbc.jts.Driver.getNonTxConnection(Driver.java:658)
        at weblogic.jdbc.jts.Driver.connect(Driver.java:127)
        at weblogic.jdbc.common.internal.RmiDataSource.getConnectionInternal(RmiDataSource.java:533)
        at weblogic.jdbc.common.internal.RmiDataSource.getConnection(RmiDataSource.java:498)
        at weblogic.jdbc.common.internal.RmiDataSource.getConnection(RmiDataSource.java:491)
        at jsp_servlet.__dbleak._jspService(__dbleak.java:85)
>

 

 

test reserve connection 적용 시 로그
<Nov 27, 2019 9:50:34 AM KST> <Info> <JDBC> <BEA-001546> <Data source connection pool "gtplus" is being started by user "weblogic".>
<Nov 27, 2019 9:50:34 AM KST> <Info> <Common> <BEA-000626> <Free resources in pool "gtplus" will be tested every "120" seconds.>

 

 

데이터 소스 인스턴스 재시작 시 로그
<Nov 27, 2019 9:50:34 AM KST> <Info> <JDBC> <BEA-001546> <Data source connection pool "gtplus" is being started by user "weblogic".>
<Nov 27, 2019 9:50:34 AM KST> <Info> <Common> <BEA-000626> <Free resources in pool "gtplus" will be tested every "120" seconds.>
<Nov 27, 2019 9:50:34 AM KST> <Info> <JDBC> <BEA-001516> <Data source connection pool "gtplus" connected to Database: "Oracle", Version: "Oracle Database 12c Enterprise Edition Release 12.2.0.1.0 - 64bit Production".>
<Nov 27, 2019 9:50:34 AM KST> <Info> <JDBC> <BEA-001517> <Data source connection pool "gtplus" using Driver: "Oracle JDBC driver", Version: "11.2.0.3.0".>
<Nov 27, 2019 9:50:34 AM KST> <Info> <Common> <BEA-000628> <Created "1" resources for pool "gtplus", out of which "1" are available and "0" are unavailable.>

 

 

db leak 으로 인한 stuck thread 발생 시 로그
<Nov 27, 2019 9:43:20 AM KST> <Error> <WebLogicServer> <BEA-000337> <[STUCK] ExecuteThread: '0' for queue: 'weblogic.kernel.Default (self-tuning)' has been busy for "647" seconds working on the request "Workmanager: default, Version: 0, Scheduled=true, Started=true, Started time: 647553 ms
[
GET /testApp/dbLeak.jsp HTTP/1.1
Connection: keep-alive
Cache-Control: max-age=0
Upgrade-Insecure-Requests: 1
User-Agent: Mozilla/5.0 (Windows NT 10.0; Win64; x64) AppleWebKit/537.36 (KHTML, like Gecko) Chrome/78.0.3904.108 Safari/537.36
Accept: text/html,application/xhtml+xml,application/xml;q=0.9,image/webp,image/apng,*/*;q=0.8,application/signed-exchange;v=b3
Accept-Encoding: gzip, deflate
Accept-Language: ko-KR,ko;q=0.9,en-US;q=0.8,en;q=0.7
Cookie: ADMINCONSOLESESSION=M5yRddBLVtXf2m2mXtHyJ92QRvZchjQdHfJbSZh6CKx08s8y3F7b!1920078949; JSESSIONID=N12TddDYzvHy8YjhWQ0nymt7TzfqzsR9t42vTjVFVtmrJvsMj1fV!-113708091


]", which is more than the configured time (StuckThreadMaxTime) of "600" seconds. Stack trace:
null>
<Nov 27, 2019 9:43:20 AM KST> <Error> <WebLogicServer> <BEA-000337> <[STUCK] ExecuteThread: '2' for queue: 'weblogic.kernel.Default (self-tuning)' has been busy for "642" seconds working on the request "Workmanager: default, Version: 1, Scheduled=true, Started=true, Started time: 642407 ms
[
GET /testApp/dbLeak.jsp HTTP/1.1
Connection: keep-alive
Cache-Control: max-age=0
Upgrade-Insecure-Requests: 1
User-Agent: Mozilla/5.0 (Windows NT 10.0; Win64; x64) AppleWebKit/537.36 (KHTML, like Gecko) Chrome/78.0.3904.108 Safari/537.36
Accept: text/html,application/xhtml+xml,application/xml;q=0.9,image/webp,image/apng,*/*;q=0.8,application/signed-exchange;v=b3
Accept-Encoding: gzip, deflate
Accept-Language: ko-KR,ko;q=0.9,en-US;q=0.8,en;q=0.7
Cookie: ADMINCONSOLESESSION=M5yRddBLVtXf2m2mXtHyJ92QRvZchjQdHfJbSZh6CKx08s8y3F7b!1920078949; JSESSIONID=N12TddDYzvHy8YjhWQ0nymt7TzfqzsR9t42vTjVFVtmrJvsMj1fV!-113708091


]", which is more than the configured time (StuckThreadMaxTime) of "600" seconds. Stack trace:
null>
<Nov 27, 2019 9:43:20 AM KST> <Error> <WebLogicServer> <BEA-000337> <[STUCK] ExecuteThread: '3' for queue: 'weblogic.kernel.Default (self-tuning)' has been busy for "647" seconds working on the request "Workmanager: default, Version: 0, Scheduled=true, Started=true, Started time: 647155 ms
[
GET /testApp/dbLeak.jsp HTTP/1.1
Connection: keep-alive
Cache-Control: max-age=0
Upgrade-Insecure-Requests: 1
User-Agent: Mozilla/5.0 (Windows NT 10.0; Win64; x64) AppleWebKit/537.36 (KHTML, like Gecko) Chrome/78.0.3904.108 Safari/537.36
Accept: text/html,application/xhtml+xml,application/xml;q=0.9,image/webp,image/apng,*/*;q=0.8,application/signed-exchange;v=b3
Accept-Encoding: gzip, deflate
Accept-Language: ko-KR,ko;q=0.9,en-US;q=0.8,en;q=0.7
Cookie: ADMINCONSOLESESSION=M5yRddBLVtXf2m2mXtHyJ92QRvZchjQdHfJbSZh6CKx08s8y3F7b!1920078949; JSESSIONID=N12TddDYzvHy8YjhWQ0nymt7TzfqzsR9t42vTjVFVtmrJvsMj1fV!-113708091


]", which is more than the configured time (StuckThreadMaxTime) of "600" seconds. Stack trace:
null>

 

 

일정 시간 동안 DB 작업 없을 시 로그
<Nov 26, 2019 5:40:45,887 PM KST> <Info> <JDBC> <BEA-001128> <Connection for pool "gtplus" has been closed.>

 

 

메모리 부족 로그
<Dec 30, 2019 1:47:57,504 PM KST> <Error> <HTTP> <BEA-101017> <[ServletContext@177876928[app:testApp2 module:testApp2 path:null spec-version:3.1]] Root cause of ServletException.
weblogic.jdbc.extensions.ConnectionDeadSQLException: weblogic.common.resourcepool.ResourceDeadException: 0:weblogic.common.ResourceException: Could not create pool connection for datasource 'gtplus'. The DBMS driver exception was: ORA-01034: ORACLE not available
ORA-27102: out of memory
Linux-x86_64 Error: 12: Cannot allocate memory
Additional information: 2731
Additional information: 131074
Additional information: 1627389952


        at weblogic.jdbc.common.internal.JDBCUtil.wrapAndThrowResourceException(JDBCUtil.java:274)
        at weblogic.jdbc.pool.Driver.connect(Driver.java:154)
        at weblogic.jdbc.jts.Driver.getNonTxConnection(Driver.java:665)
        at weblogic.jdbc.jts.Driver.connect(Driver.java:129)
        at weblogic.jdbc.common.internal.RmiDataSource.getConnectionInternal(RmiDataSource.java:638)
        Truncated. see log file for complete stacktrace
>