java - Statement.setQueryTimeout 不适用于 Oracle 18c jdbc 驱动程序

Question

我们在 payara 5.2020 服务器上有一个 J2EE 应用程序，它执行长时间运行的查询(执行几个小时的 PL/SQL)。
为了避免超时异常，我们在StatementLevel使用这句话:

statement.setQueryTimeout(0);

这适用于 Oracle jdbc 驱动程序版本 12c，但是当我们迁移到 Oracle 18c 并且我们将驱动程序更改为版本 18c 时，查询执行在 15 分钟后停止，出现此异常。该代码适用于 Oracle 12 和 Oracle 18 是驱动程序 jar 中的更改导致问题的原因。
问题已经在Linux和Windows机器上重现:

2021-06-14T07:50:01.762+0200|SEVERE: java.sql.SQLRecoverableException: Error de E/S: Socket read interrupted
    at oracle.jdbc.driver.T4CCallableStatement.executeForRows(T4CCallableStatement.java:946)
    at oracle.jdbc.driver.OracleStatement.doExecuteWithTimeout(OracleStatement.java:1136)
    at oracle.jdbc.driver.OraclePreparedStatement.executeInternal(OraclePreparedStatement.java:3640)
    at oracle.jdbc.driver.T4CCallableStatement.executeInternal(T4CCallableStatement.java:1318)
    at oracle.jdbc.driver.OraclePreparedStatement.execute(OraclePreparedStatement.java:3752)
    at oracle.jdbc.driver.OracleCallableStatement.execute(OracleCallableStatement.java:4242)
    at oracle.jdbc.driver.OraclePreparedStatementWrapper.execute(OraclePreparedStatementWrapper.java:1079)
    at com.sun.gjc.spi.base.PreparedStatementWrapper.execute(PreparedStatementWrapper.java:532)
    at java.base/jdk.internal.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
    at java.base/jdk.internal.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:62)
    at java.base/jdk.internal.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43)
    at java.base/java.lang.reflect.Method.invoke(Method.java:566)
    at com.sun.gjc.spi.jdbc40.ProfiledConnectionWrapper40$1.invoke(ProfiledConnectionWrapper40.java:437)
    at com.sun.proxy.$Proxy324.execute(Unknown Source)
    at org.apache.jsp.index_jsp.callPL(index_jsp.java:49)
    at org.apache.jsp.index_jsp._jspService(index_jsp.java:108)
    at org.apache.jasper.runtime.HttpJspBase.service(HttpJspBase.java:111)
    at javax.servlet.http.HttpServlet.service(HttpServlet.java:750)
    at org.apache.jasper.servlet.JspServletWrapper.service(JspServletWrapper.java:411)
    at org.apache.jasper.servlet.JspServlet.serviceJspFile(JspServlet.java:473)
    at org.apache.jasper.servlet.JspServlet.service(JspServlet.java:377)
    at javax.servlet.http.HttpServlet.service(HttpServlet.java:750)
    at org.apache.catalina.core.StandardWrapper.service(StandardWrapper.java:1636)
    at org.apache.catalina.core.StandardWrapperValve.invoke(StandardWrapperValve.java:259)
    at org.apache.catalina.core.StandardContextValve.invoke(StandardContextValve.java:161)
    at org.apache.catalina.core.StandardPipeline.doInvoke(StandardPipeline.java:757)
    at org.apache.catalina.core.StandardPipeline.invoke(StandardPipeline.java:577)
    at com.sun.enterprise.web.WebPipeline.invoke(WebPipeline.java:99)
    at org.apache.catalina.core.StandardHostValve.invoke(StandardHostValve.java:158)
    at org.apache.catalina.connector.CoyoteAdapter.doService(CoyoteAdapter.java:371)
    at org.apache.catalina.connector.CoyoteAdapter.service(CoyoteAdapter.java:238)
    at com.sun.enterprise.v3.services.impl.ContainerMapper$HttpHandlerCallable.call(ContainerMapper.java:520)
    at com.sun.enterprise.v3.services.impl.ContainerMapper.service(ContainerMapper.java:217)
    at org.glassfish.grizzly.http.server.HttpHandler.runService(HttpHandler.java:182)
    at org.glassfish.grizzly.http.server.HttpHandler.doHandle(HttpHandler.java:156)
    at org.glassfish.grizzly.http.server.HttpServerFilter.handleRead(HttpServerFilter.java:218)
    at org.glassfish.grizzly.filterchain.ExecutorResolver$9.execute(ExecutorResolver.java:95)
    at org.glassfish.grizzly.filterchain.DefaultFilterChain.executeFilter(DefaultFilterChain.java:260)
    at org.glassfish.grizzly.filterchain.DefaultFilterChain.executeChainPart(DefaultFilterChain.java:177)
    at org.glassfish.grizzly.filterchain.DefaultFilterChain.execute(DefaultFilterChain.java:109)
    at org.glassfish.grizzly.filterchain.DefaultFilterChain.process(DefaultFilterChain.java:88)
    at org.glassfish.grizzly.ProcessorExecutor.execute(ProcessorExecutor.java:53)
    at org.glassfish.grizzly.nio.transport.TCPNIOTransport.fireIOEvent(TCPNIOTransport.java:524)
    at org.glassfish.grizzly.strategies.AbstractIOStrategy.fireIOEvent(AbstractIOStrategy.java:89)
    at org.glassfish.grizzly.strategies.WorkerThreadIOStrategy.run0(WorkerThreadIOStrategy.java:94)
    at org.glassfish.grizzly.strategies.WorkerThreadIOStrategy.access$100(WorkerThreadIOStrategy.java:33)
    at org.glassfish.grizzly.strategies.WorkerThreadIOStrategy$WorkerThreadRunnable.run(WorkerThreadIOStrategy.java:114)
    at org.glassfish.grizzly.threadpool.AbstractThreadPool$Worker.doWork(AbstractThreadPool.java:569)
    at org.glassfish.grizzly.threadpool.AbstractThreadPool$Worker.run(AbstractThreadPool.java:549)
    at java.base/java.lang.Thread.run(Thread.java:834)
Caused by: java.io.InterruptedIOException: Socket read interrupted
    at oracle.net.nt.TimeoutSocketChannel.handleInterrupt(TimeoutSocketChannel.java:262)
    at oracle.net.nt.TimeoutSocketChannel.read(TimeoutSocketChannel.java:184)
    at oracle.net.ns.NSProtocolNIO.doSocketRead(NSProtocolNIO.java:544)
    at oracle.net.ns.NIOPacket.readHeader(NIOPacket.java:234)
    at oracle.net.ns.NIOPacket.readPacketFromSocketChannel(NIOPacket.java:174)
    at oracle.net.ns.NIOPacket.readFromSocketChannel(NIOPacket.java:122)
    at oracle.net.ns.NIOPacket.readFromSocketChannel(NIOPacket.java:100)
    at oracle.net.ns.NIONSDataChannel.readDataFromSocketChannel(NIONSDataChannel.java:86)
    at oracle.jdbc.driver.T4CMAREngineNIO.prepareForUnmarshall(T4CMAREngineNIO.java:762)
    at oracle.jdbc.driver.T4CMAREngineNIO.unmarshalUB1(T4CMAREngineNIO.java:427)
    at oracle.jdbc.driver.T4CTTIfun.receive(T4CTTIfun.java:394)
    at oracle.jdbc.driver.T4CTTIfun.doRPC(T4CTTIfun.java:255)
    at oracle.jdbc.driver.T4C8Oall.doOALL(T4C8Oall.java:610)
    at oracle.jdbc.driver.T4CCallableStatement.doOall8(T4CCallableStatement.java:249)
    at oracle.jdbc.driver.T4CCallableStatement.doOall8(T4CCallableStatement.java:82)
    at oracle.jdbc.driver.T4CCallableStatement.executeForRows(T4CCallableStatement.java:924)

看来传输层已经迁移到 java.nio 并且方法 setQueryTimeout 不再
我们尝试过的事情:

在payara 控制台的JDBC 连接池高级属性屏幕中将默认语句超时设置为-1。

尝试直接在与 conn.setNetworkTimeout(Executors.newFixedThreadPool(1), 0) 的连接中设置时间没有任何效果。

在不同的来源中，我们发现以下这些属性会影响网络超时评估。我们将它们设置为 payara 启动的 JVM 属性 (-Doracle.net.CONNECT_TIMEOUT=xxx) 和 JDBC 连接池属性，这两种情况的值都为 0 和 -1。在任何情况下都不起作用。

oracle.net.CONNECT_TIMEOUT

oracle.net.READ_TIMEOUT

oracle.jdbc.ReadTimeout

资料来源:

Oracle 18c Net services best practices

Oracle 18c java jdbc reference. E.1.5 Using JDBC with Firewalls

4.- 由于我们通过payara DataSource池访问DataSource，我们无法将com.sun.gjc.spi.jdbc40.DataSource40(payara提供的类)转换为OracleDataSource，但我们以编程方式创建了DataSorce来设置连接属性如图 here并设置上图中看到的属性，但它不起作用:

public static Properties oracleProperties() {
    // Already tried -1 and 0
    Properties properties = new Properties();
    properties.put("Oracle.net.CONNECT_TIMEOUT", 0);
    properties.put("Oracle.net.READ_TIMEOUT", 0);
    properties.put("Oracle.jdbc.ReadTimeout", 0);
    return properties;
}

public static OracleDataSource createDataSource() throws Exception {
    OracleDataSource ods = new OracleDataSource();
    ods.setURL("jdbc:oracle:thin:@itauc4602x:1521/BDExp");
    ods.setUser("enevac");
    ods.setPassword("enevac");
    ods.setDataSourceName("OracleXADataSource");
    ods.setLoginTimeout(0);
    // default connection properties to avoid timeoutException
    ods.setConnectionProperties(oracleProperties());
    return ods;
}

有没有人遇到过这个问题，知道如何避免超时限制吗？

为什么是 15 分钟？，according to the reference ，oracle.net.ReadTimeout 的默认值为 10 分钟。

更新:
为了更详细地解释为什么我认为问题出在驱动程序中以及为什么我放弃了异常的其他可能来源，我假设可以从三个来源引发超时:

网络超时:我丢弃它，因为我正在我的本地机器上针对开发数据库测试 payara 服务器，中间没有防火墙。

数据库服务器:DBA 已经检查了 Oracle 网络服务配置，并且没有限制设置来解释 15 分钟的削减。此外，在这些情况下，会出现带有某种 ORA-xxx 错误代码的 SQLException。

JDBC:可以在连接级别、语句级别和事务级别设置。正如我在开头所说的，该代码适用于针对 Oracle 12 和 Oracle 18 服务器的 oracle 12c 驱动程序，是驱动程序 jar 的更改导致代码停止工作。

Answer 1

最后，在payara 池中配置OracleDataSource 的“connectionProperties”自定义属性解决了问题。正如@ibre5041 所指出的，设置属性 oracle.jdbc.javaNetNio=false 会更改驱动程序使用的传输层，并且它开始作为 oracle 12c 以前的版本工作。
根据Oracle reference ，OracleDataSource 实现者可以将连接属性作为 java.util.Properties 对象接收。
表 8-2 Oracle 扩展数据源属性

名称:连接属性

类型:java.util.Properties

说明:指定连接属性。

要在 Payara 管理控制台中为 jdbc 池设置多值属性，您必须将属性设置为 (prop1=value1,prop2=value2), ( Thank you again Ondro Mihályi )。所以在我们的例子中，我们设置:
connectionProperties = (oracle.jdbc.ReadTimeout=0, oracle.jdbc.javaNetNio=false)
作为使用 Oracle 18c jdbc 驱动程序的工作和不工作的总结(每一步都单独测试):

在语句级别设置超时不起作用:
语句.setQueryTimeout(0)

在连接级别设置超时，使用 -1 或 0，不起作用:
conn.setNetworkTimeout(Executors.newFixedThreadPool(1), 以毫秒为单位的超时时间)

使用 OracleDataSource 在 java.util.connection 中以编程方式设置超时属性使其按照问题中的指示工作。

如果限制低于 15 分钟，则将超时属性设置为 JVM 属性使其工作，但如果您设置的值 > 15 分钟，则会引发异常，因此设置为 0 或 -1 无效:

所以这使得查询在 10 秒后停止:
-Doracle.net.CONNECT_TIMEOUT=10000 -Doracle.net.READ_TIMEOUT=10000 -Doracle.jdbc.ReadTimeout=10000
但是在 15 分钟后停止:
-Doracle.net.CONNECT_TIMEOUT=-1 -Doracle.net.READ_TIMEOUT=-1 -Doracle.jdbc.ReadTimeout=-1

将 oracle.net.keepAlive=true 设置为 @Nirmala 建议的 JVM 属性不起作用。

将 oracle.jdbc.javaNetNio=false 设置为 JVM 属性 @ibre5041 让它工作 .所以它指出了 java.nio 传输层的一些问题。

无论如何，我们向 Oracle 提出了一个支持问题，导致 jdbc api 语句。setQueryTimeout(0) 应该可以工作，而无需配置数据源，我会在案例关闭时放置响应。