2026-06-18 02:00:00.010 INFO  [JKS-BATCH-NIGHTLY] [host=batch01/10.20.40.21] jobId=NB20260618-0200 - 夜間バッチ 起動 profile=prod build=2026.06.09-r3
2026-06-18 02:00:00.115 INFO  [JKS-BATCH-NIGHTLY] [host=batch01/10.20.40.21] jobId=NB20260618-0200 - DataSource初期化 url=jdbc:postgresql://db-primary/10.20.40.50:5432/jks pool=HikariPool-batch maxPoolSize=10
2026-06-18 02:00:01.302 INFO  [JKS-BATCH-NIGHTLY] [host=batch01/10.20.40.21] jobId=NB20260618-0200 - STEP1 受注締め処理 開始
2026-06-18 02:00:01.455 DEBUG [JKS-BATCH-NIGHTLY] [host=batch01/10.20.40.21] jobId=NB20260618-0200 - SQL: SELECT * FROM T_JUCHU WHERE STATUS=1 AND SHIME_FLG=0
2026-06-18 02:01:44.870 INFO  [JKS-BATCH-NIGHTLY] [host=batch01/10.20.40.21] jobId=NB20260618-0200 - STEP1 対象 3,182件 締め処理 完了 elapsed=103s
2026-06-18 02:01:45.001 INFO  [JKS-BATCH-NIGHTLY] [host=batch01/10.20.40.21] jobId=NB20260618-0200 - STEP2 売上実績集計 開始
2026-06-18 02:01:45.120 DEBUG [JKS-BATCH-NIGHTLY] [host=batch01/10.20.40.21] jobId=NB20260618-0200 - SQL: INSERT INTO T_URIAGE SELECT ... FROM T_JUCHU WHERE SHIME_FLG=1
2026-06-18 02:04:10.540 INFO  [JKS-BATCH-NIGHTLY] [host=batch01/10.20.40.21] jobId=NB20260618-0200 - STEP2 売上実績 2,905件 登録 完了 elapsed=145s
2026-06-18 02:04:10.700 INFO  [JKS-BATCH-NIGHTLY] [host=batch01/10.20.40.21] jobId=NB20260618-0200 - STEP3 顧客別明細出力 開始（並列度=8）
2026-06-18 02:04:10.850 DEBUG [JKS-BATCH-NIGHTLY] [host=batch01/10.20.40.21] jobId=NB20260618-0200 - worker-1 コネクション取得 active=1/10
2026-06-18 02:04:10.902 DEBUG [JKS-BATCH-NIGHTLY] [host=batch01/10.20.40.21] jobId=NB20260618-0200 - worker-2 コネクション取得 active=2/10
2026-06-18 02:04:10.955 DEBUG [JKS-BATCH-NIGHTLY] [host=batch01/10.20.40.21] jobId=NB20260618-0200 - worker-3 コネクション取得 active=3/10
2026-06-18 02:04:11.011 DEBUG [JKS-BATCH-NIGHTLY] [host=batch01/10.20.40.21] jobId=NB20260618-0200 - worker-4 コネクション取得 active=4/10
2026-06-18 02:04:11.070 DEBUG [JKS-BATCH-NIGHTLY] [host=batch01/10.20.40.21] jobId=NB20260618-0200 - worker-5 コネクション取得 active=5/10
2026-06-18 02:05:32.400 WARN  [JKS-BATCH-NIGHTLY] [host=batch01/10.20.40.21] jobId=NB20260618-0200 - 別ジョブ JKS-BATCH-CUSTSYNC がDataSourceを共有利用中 active=9/10
2026-06-18 02:05:33.150 DEBUG [JKS-BATCH-NIGHTLY] [host=batch01/10.20.40.21] jobId=NB20260618-0200 - worker-6 コネクション取得待機 active=10/10 waiting=1
2026-06-18 02:05:34.220 DEBUG [JKS-BATCH-NIGHTLY] [host=batch01/10.20.40.21] jobId=NB20260618-0200 - worker-7 コネクション取得待機 active=10/10 waiting=2
2026-06-18 02:05:35.310 DEBUG [JKS-BATCH-NIGHTLY] [host=batch01/10.20.40.21] jobId=NB20260618-0200 - worker-8 コネクション取得待機 active=10/10 waiting=3
2026-06-18 02:05:48.660 WARN  [JKS-BATCH-NIGHTLY] [host=batch01/10.20.40.21] jobId=NB20260618-0200 - コネクション取得が想定より遅延しています waiting=3 connectionTimeout=30000ms
2026-06-18 02:06:03.900 WARN  [JKS-BATCH-NIGHTLY] [host=batch01/10.20.40.21] jobId=NB20260618-0200 - HikariPool-batch - Connection is not available, request timed out after 30001ms
2026-06-18 02:06:03.955 ERROR [JKS-BATCH-NIGHTLY] [host=batch01/10.20.40.21] jobId=NB20260618-0200 - STEP3 worker-6 でエラーが発生しました
java.sql.SQLTransientConnectionException: HikariPool-batch - Connection is not available, request timed out after 30001ms (total=10, active=10, idle=0, waiting=3)
	at com.zaxxer.hikari.pool.HikariPool.createTimeoutException(HikariPool.java:696)
	at com.zaxxer.hikari.pool.HikariPool.getConnection(HikariPool.java:197)
	at jp.co.hoshino.jks.batch.CustomerDetailWriter.write(CustomerDetailWriter.java:88)
	at org.springframework.batch.core.step.item.SimpleChunkProcessor.write(SimpleChunkProcessor.java:294)
2026-06-18 02:06:34.010 WARN  [JKS-BATCH-NIGHTLY] [host=batch01/10.20.40.21] jobId=NB20260618-0200 - HikariPool-batch - Connection is not available, request timed out after 30000ms
2026-06-18 02:06:34.060 ERROR [JKS-BATCH-NIGHTLY] [host=batch01/10.20.40.21] jobId=NB20260618-0200 - STEP3 worker-7 でエラーが発生しました
java.sql.SQLTransientConnectionException: HikariPool-batch - Connection is not available, request timed out after 30000ms (total=10, active=10, idle=0, waiting=2)
	at com.zaxxer.hikari.pool.HikariPool.createTimeoutException(HikariPool.java:696)
	at com.zaxxer.hikari.pool.HikariPool.getConnection(HikariPool.java:197)
	at jp.co.hoshino.jks.batch.CustomerDetailWriter.write(CustomerDetailWriter.java:88)
2026-06-18 02:07:05.220 ERROR [JKS-BATCH-NIGHTLY] [host=batch01/10.20.40.21] jobId=NB20260618-0200 - STEP3 worker-8 でエラーが発生しました Connection pool exhausted
2026-06-18 02:07:05.400 ERROR [JKS-BATCH-NIGHTLY] [host=batch01/10.20.40.21] jobId=NB20260618-0200 - STEP3 顧客別明細出力 リトライ上限に到達 retry=3/3
2026-06-18 02:07:05.560 ERROR [JKS-BATCH-NIGHTLY] [host=batch01/10.20.40.21] jobId=NB20260618-0200 - STEP3 顧客別明細出力 失敗 処理件数=1,204/4,880
2026-06-18 02:07:05.700 ERROR [JKS-BATCH-NIGHTLY] [host=batch01/10.20.40.21] jobId=NB20260618-0200 - ジョブを中断します exitStatus=FAILED
2026-06-18 02:07:06.010 ERROR [JKS-BATCH-NIGHTLY] [host=batch01/10.20.40.21] jobId=NB20260618-0200 - ##### JOB ABNORMAL END ##### jobId=NB20260618-0200 elapsed=426s
2026-06-18 02:07:06.150 INFO  [JKS-BATCH-NIGHTLY] [host=batch01/10.20.40.21] jobId=NB20260618-0200 - DataSource クローズ HikariPool-batch shutdown
2026-06-18 02:07:06.300 WARN  [JKS-BATCH-NIGHTLY] [host=batch01/10.20.40.21] jobId=NB20260618-0200 - 後続ジョブ JKS-BATCH-REPORT はSTEP3未完のためスキップされました
