DEBUG no GFAL_CONFIG_DIR env var found, try to load configuration from default directory /etc/gfal2.d/ DEBUG try to load configuration file /etc/gfal2.d//gfal2_core.conf ... DEBUG try to load configuration file /etc/gfal2.d//rfio_plugin.conf ... DEBUG try to load configuration file /etc/gfal2.d//dcap_plugin.conf ... DEBUG try to load configuration file /etc/gfal2.d//http_plugin.conf ... DEBUG try to load configuration file /etc/gfal2.d//gsiftp_plugin.conf ... DEBUG try to load configuration file /etc/gfal2.d//x509.conf ... DEBUG try to load configuration file /etc/gfal2.d//srm_plugin.conf ... DEBUG try to load configuration file /etc/gfal2.d//bdii.conf ... DEBUG try to load configuration file /etc/gfal2.d//sftp_plugin.conf ... DEBUG try to load configuration file /etc/gfal2.d//xrootd_plugin.conf ... DEBUG try to load configuration file /etc/gfal2.d//lfc_plugin.conf ... DEBUG Using credentials from X509_USER_PROXY DEBUG Certificate: /tmp/x509up_u21037 DEBUG Private key: /tmp/x509up_u21037 DEBUG ... no GFAL_PLUGIN_DIR environment variable specified, try to load plugins in the default directory : /usr/lib64/gfal2-plugins/ DEBUG [gfal_list_directory_plugins] add plugin to list to load /usr/lib64/gfal2-plugins//libgfal_plugin_sftp.so DEBUG [gfal_list_directory_plugins] add plugin to list to load /usr/lib64/gfal2-plugins//libgfal_plugin_srm.so DEBUG [gfal_list_directory_plugins] add plugin to list to load /usr/lib64/gfal2-plugins//libgfal_plugin_file.so DEBUG [gfal_list_directory_plugins] add plugin to list to load /usr/lib64/gfal2-plugins//libgfal_plugin_lfc.so DEBUG [gfal_list_directory_plugins] add plugin to list to load /usr/lib64/gfal2-plugins//libgfal_plugin_rfio.so DEBUG [gfal_list_directory_plugins] add plugin to list to load /usr/lib64/gfal2-plugins//libgfal_plugin_dcap.so DEBUG [gfal_list_directory_plugins] add plugin to list to load /usr/lib64/gfal2-plugins//libgfal_plugin_gridftp.so DEBUG [gfal_list_directory_plugins] add plugin to list to load /usr/lib64/gfal2-plugins//libgfal_plugin_http.so DEBUG [gfal_list_directory_plugins] add plugin to list to load /usr/lib64/gfal2-plugins//libgfal_plugin_xrootd.so INFO [gfal_module_load] plugin /usr/lib64/gfal2-plugins//libgfal_plugin_sftp.so loaded with success DEBUG gfal_plugin loaded succesfully : /usr/lib64/gfal2-plugins//libgfal_plugin_sftp.so INFO [gfal_module_load] plugin /usr/lib64/gfal2-plugins//libgfal_plugin_srm.so loaded with success DEBUG gfal_plugin loaded succesfully : /usr/lib64/gfal2-plugins//libgfal_plugin_srm.so INFO [gfal_module_load] plugin /usr/lib64/gfal2-plugins//libgfal_plugin_file.so loaded with success DEBUG gfal_plugin loaded succesfully : /usr/lib64/gfal2-plugins//libgfal_plugin_file.so INFO [gfal_module_load] plugin /usr/lib64/gfal2-plugins//libgfal_plugin_lfc.so loaded with success DEBUG gfal_plugin loaded succesfully : /usr/lib64/gfal2-plugins//libgfal_plugin_lfc.so DEBUG lib rfio is not defined in LCG_RFIO_TYPE, try to found it DEBUG rfio library libdpm.so.1 found! configured to use it INFO [gfal_module_load] plugin /usr/lib64/gfal2-plugins//libgfal_plugin_rfio.so loaded with success DEBUG gfal_plugin loaded succesfully : /usr/lib64/gfal2-plugins//libgfal_plugin_rfio.so INFO [gfal_module_load] plugin /usr/lib64/gfal2-plugins//libgfal_plugin_dcap.so loaded with success DEBUG gfal_plugin loaded succesfully : /usr/lib64/gfal2-plugins//libgfal_plugin_dcap.so DEBUG -> [gridftp_plugin] try to load .. DEBUG define GSIFTP session re-use to TRUE DEBUG -> [gridftp_plugin] loaded .. INFO [gfal_module_load] plugin /usr/lib64/gfal2-plugins//libgfal_plugin_gridftp.so loaded with success DEBUG gfal_plugin loaded succesfully : /usr/lib64/gfal2-plugins//libgfal_plugin_gridftp.so DEBUG Davix: Enable GRID profile for DAVIX DEBUG Davix: Adding CA path /etc/grid-security/certificates/ to valid CA path list DEBUG Davix: Using X509_USER_PROXY to supply credentials: /tmp/x509up_u21037 INFO [gfal_module_load] plugin /usr/lib64/gfal2-plugins//libgfal_plugin_http.so loaded with success DEBUG gfal_plugin loaded succesfully : /usr/lib64/gfal2-plugins//libgfal_plugin_http.so INFO [gfal_module_load] plugin /usr/lib64/gfal2-plugins//libgfal_plugin_xrootd.so loaded with success DEBUG gfal_plugin loaded succesfully : /usr/lib64/gfal2-plugins//libgfal_plugin_xrootd.so DEBUG plugin priority order: lfc-2.18.2 -> sftp-2.18.2 -> srm-2.18.2 -> file-2.18.2 -> rfio-2.18.2 -> dcap-2.18.2 -> gridftp-2.18.2 -> http-2.18.2 -> xrootd-2.18.2 -> DEBUG Using client X509 for HTTPS session authorization DEBUG Davix: ssl: Match common name '895748149' against '' DEBUG Davix: Identity match for '': bad DEBUG Davix: ssl: Match common name '895748149' against '' DEBUG Davix: Identity match for '': bad DEBUG Impossible to get string parameter BEARER:TOKEN, set to default value (null), err Key file does not have group “BEARER” DEBUG Impossible to get string parameter BEARER:TOKEN, set to default value (null), err Key file does not have group “BEARER” DEBUG Impossible to get boolean parameter S3:DCACHE.IJS.SI:ALTERNATE, set to default value FALSE, err Key file does not have group “S3:DCACHE.IJS.SI” DEBUG Impossible to get boolean parameter S3:IJS.SI:ALTERNATE, set to default value FALSE, err Key file does not have group “S3:IJS.SI” DEBUG Impossible to get boolean parameter S3:ALTERNATE, set to default value FALSE, err Key file does not have group “S3” DEBUG Impossible to get string_list parameter HTTP PLUGIN:HEADERS, set to a default value (null), err Key file does not have key “HEADERS” in group “HTTP PLUGIN” DEBUG Impossible to get integer parameter HTTP PLUGIN:OPERATION_TIMEOUT, set to default value 8000, err Key file does not have key “OPERATION_TIMEOUT” in group “HTTP PLUGIN” DEBUG Davix: Create HttpRequest for davs://dcache.ijs.si:2880/pnfs/ijs.si/belle/TMP/belle/test/TPC/1G-test-push-Napoli-TMP-SE DEBUG Davix: ssl: Match common name '895748149' against '' DEBUG Davix: Identity match for '': bad DEBUG Davix: ssl: Match common name '895748149' against '' DEBUG Davix: Identity match for '': bad DEBUG Davix: -> executeRequest DEBUG Davix: creating session keys... httpsdcache.ijs.si:2880 DEBUG Davix: no cached ne_session, create a new one DEBUG Davix: HTTP session to https://dcache.ijs.si:2880 begins. DEBUG Davix: ssl: SNI enabled by default. DEBUG Davix: configure session... DEBUG Davix: define connection timeout to 30 DEBUG Davix: define operation timeout to 8000 DEBUG Davix: add CA PATH /etc/grid-security/certificates/ DEBUG Davix: disable login/password authentication DEBUG Davix: enable client cert authentication by callback DEBUG Davix: -> negotiateRequest DEBUG Davix: NEON start internal request DEBUG Davix: Running pre_send hooks DEBUG Davix: > PROPFIND /pnfs/ijs.si/belle/TMP/belle/test/TPC/1G-test-push-Napoli-TMP-SE HTTP/1.1 > User-Agent: gfal2-util/1.6.0 gfal2/2.18.2 neon/0.0.29 > Keep-Alive: > Connection: Keep-Alive > TE: trailers > Host: dcache.ijs.si:2880 > Depth: 0 > DEBUG Davix: Sending request-line and headers: DEBUG Davix: Doing DNS lookup on dcache.ijs.si... DEBUG Davix: Doing SSL negotiation. DEBUG Davix: Calling client certificate provider... DEBUG Davix: clicert callback DEBUG Davix: call client cert callback DEBUG Davix: ssl: Match common name '895748149' against '' DEBUG Davix: Identity match for '': bad DEBUG Davix: ssl: Match common name '895748149' against '' DEBUG Davix: Identity match for '': bad DEBUG Davix: Supplying client certificate. DEBUG Davix: Chain depth: 1 DEBUG Davix: ssl: Match common name 'dcache.ijs.si' against '' DEBUG Davix: Identity match for '': bad DEBUG Davix: Cert #0: DEBUG Davix: Certificate: Data: Version: 3 (0x2) Serial Number: 2561 (0xa01) Signature Algorithm: sha512WithRSAEncryption Issuer: C=SI, O=SiGNET, CN=SiGNET CA Validity Not Before: Aug 23 14:17:41 2021 GMT Not After : Aug 23 14:17:41 2022 GMT Subject: C=SI, O=SiGNET, O=IJS, OU=F9, CN=dcache.ijs.si Subject Public Key Info: Public Key Algorithm: rsaEncryption Public-Key: (4096 bit) Modulus: 00:ae:79:13:3e:38:b1:a5:87:a4:54:9d:df:d9:65: 6b:d2:e3:4a:75:49:ed:a7:c6:ef:be:99:ca:c0:17: 6f:e3:b1:7e:92:37:07:e5:fc:4b:af:48:8a:4f:59: e5:f7:f6:21:0d:13:26:ea:e0:04:de:83:15:07:b9: 30:0e:0e:1e:fd:c3:58:5b:76:91:68:c9:cb:92:23: 3a:a4:6a:b5:6b:3c:1f:fe:9b:f2:8c:b8:18:67:d9: 52:b4:6d:7f:fe:33:a2:91:6d:1c:fe:98:e7:af:84: f5:8a:29:35:06:f6:c4:fb:ea:dc:4d:48:0a:95:a6: 23:0d:8e:1d:20:d2:ea:46:68:53:17:fd:24:43:43: 37:04:f0:3d:29:87:0c:d5:ae:61:1d:34:81:6f:b4: e6:2e:b7:0a:8a:0d:47:b6:00:be:50:ed:89:30:9e: 52:f7:5a:79:d9:38:21:8a:70:48:74:5e:dc:10:cc: ba:63:53:01:3f:66:1a:8b:d5:fb:f7:ad:45:8b:8e: a4:13:23:08:76:96:7c:c8:32:35:e8:a8:a9:6a:a2: 3d:85:5b:e0:16:c0:e8:cf:1d:86:06:1c:4a:ea:46: 8f:d4:63:da:7c:5f:2f:f1:fc:2a:0e:39:1a:15:ae: 2f:88:c0:38:e9:1f:df:8e:60:65:ea:c2:0b:e0:40: 97:71:1d:bf:31:bf:8f:34:72:4a:6c:89:e3:3e:be: e1:49:d8:4b:f4:7d:8d:3a:48:0b:6b:e9:af:50:8f: 43:df:f4:58:f8:08:ba:f0:41:c3:7a:27:f9:71:da: 23:dc:c3:b0:d9:24:7f:67:bf:92:1b:df:b0:ee:e3: 65:10:2c:94:b4:80:c7:b9:1e:2e:b4:ec:bd:5f:02: 00:cc:0c:6c:df:0b:e4:eb:8e:cf:50:18:01:03:53: 09:7e:0e:ae:2f:0c:02:fc:35:33:07:93:a0:9d:19: 25:2a:22:69:82:40:0c:47:07:94:ef:6e:32:79:a1: 74:0a:24:68:ce:ce:9e:51:96:60:04:d6:03:b2:09: 60:6b:ba:0a:5b:e6:f3:f6:79:df:9b:33:68:13:80: 35:3b:e9:43:f8:37:ac:22:6e:25:ae:f4:2e:4c:c4: 67:f3:82:75:dd:94:cc:21:7a:ef:42:88:41:d4:1b: c2:ad:e1:13:e0:c2:0a:92:45:50:57:12:9c:2a:76: 7f:8f:12:3f:18:58:15:d1:e5:f7:ef:4d:69:a6:0e: 5c:64:07:23:d0:e0:fa:5c:b4:bc:5f:5d:5e:5d:bd: 29:15:24:1e:f6:2e:92:2a:22:84:1d:6f:da:32:c3: 73:39:68:1c:6a:39:e1:e9:a8:77:52:f9:b6:02:b3: 13:5c:ab Exponent: 65537 (0x10001) X509v3 extensions: X509v3 Basic Constraints: CA:FALSE Netscape Cert Type: SSL Client, SSL Server X509v3 Key Usage: Digital Signature, Non Repudiation, Key Encipherment, Data Encipherment X509v3 Extended Key Usage: TLS Web Server Authentication, TLS Web Client Authentication Netscape Comment: Server-Client of SiGNET X509v3 Subject Key Identifier: EF:8F:FB:2F:C1:4A:A5:51:CC:C2:7F:B6:AD:72:B4:92:F5:5A:80:76 X509v3 Authority Key Identifier: keyid:C9:C6:73:3C:B7:A7:03:BF:74:AA:BF:3C:BE:EB:4E:EF:01:65:E5:F1 DirName:/C=SI/O=SiGNET/CN=SiGNET CA serial:00 X509v3 Subject Alternative Name: email:grid.admin@ijs.si, DNS:dcache.ijs.si X509v3 Issuer Alternative Name: email:signet-ca@ijs.si X509v3 Certificate Policies: Policy: 1.3.6.1.4.1.15312.3.1.1.0 Netscape CA Revocation Url: http://signet-ca.ijs.si/pub/crl/signet02crl.crl Netscape Revocation Url: http://signet-ca.ijs.si/pub/crl/signet0 DEBUG Davix: ssl: Match common name 'dcache.ijs.si' against 'dcache.ijs.si' DEBUG Davix: Identity match for 'dcache.ijs.si': good DEBUG Davix: Request sent; retry is 0. DEBUG Davix: < HTTP/1.1 404 Not Found DEBUG Davix: < Date: Wed, 23 Mar 2022 10:49:19 GMT DEBUG Davix: < Server: dCache/6.2.32 DEBUG Davix: < Content-Type: text/html DEBUG Davix: < Transfer-Encoding: chunked DEBUG Davix: < DEBUG Davix: End of headers. DEBUG Davix: Running post_headers hooks DEBUG Davix: <- negotiateRequest DEBUG Davix: Bad server answer: Content-Length Invalid, impossible to determine answer size DEBUG Davix: NEON Read data flow DEBUG Davix: [chunk] < F0D DEBUG Davix: Got chunk size: 3853 DEBUG Davix: Reading 3853 bytes of response body. DEBUG Davix: Got 3853 bytes. DEBUG Davix: NEONRequest::readBlock read 3853 bytes DEBUG Davix: NEON Read data flow DEBUG Davix: [chunk] < 0 DEBUG Davix: Got chunk size: 0 DEBUG Davix: NEONRequest::readBlock read 0 bytes DEBUG Davix: < DEBUG Davix: End of headers. DEBUG Davix: Running post_send hooks DEBUG Davix: <- executeRequest DEBUG Davix: Destroy HttpRequest DEBUG Davix: Running destroy hooks. DEBUG Davix: Request ends. DEBUG Davix: add old session to cache httpsdcache.ijs.si:2880 INFO Davix: Negative result for operation: HTTP 404 : File not found . After 1 retry INFO Davix: Could not execute operation on davs://dcache.ijs.si:2880/pnfs/ijs.si/belle/TMP/belle/test/TPC/1G-test-push-Napoli-TMP-SE, error Result HTTP 404 : File not found after 1 attempts INFO Davix: Try to Recover with Metalink... DEBUG Davix: Create HttpRequest for davs://dcache.ijs.si:2880/pnfs/ijs.si/belle/TMP/belle/test/TPC/1G-test-push-Napoli-TMP-SE DEBUG Davix: Executing head query to davs://dcache.ijs.si:2880/pnfs/ijs.si/belle/TMP/belle/test/TPC/1G-test-push-Napoli-TMP-SE for Metalink file DEBUG Davix: ssl: Match common name '895748149' against '' DEBUG Davix: Identity match for '': bad DEBUG Davix: ssl: Match common name '895748149' against '' DEBUG Davix: Identity match for '': bad DEBUG Davix: -> executeRequest DEBUG Davix: creating session keys... httpsdcache.ijs.si:2880 DEBUG Davix: cached ne_session found ! taken from cache DEBUG Davix: configure session... DEBUG Davix: define connection timeout to 30 DEBUG Davix: define operation timeout to 8000 DEBUG Davix: add CA PATH /etc/grid-security/certificates/ DEBUG Davix: disable login/password authentication DEBUG Davix: enable client cert authentication by callback DEBUG Davix: -> negotiateRequest DEBUG Davix: NEON start internal request DEBUG Davix: Running pre_send hooks DEBUG Davix: > HEAD /pnfs/ijs.si/belle/TMP/belle/test/TPC/1G-test-push-Napoli-TMP-SE HTTP/1.1 > User-Agent: gfal2-util/1.6.0 gfal2/2.18.2 neon/0.0.29 > TE: trailers > Host: dcache.ijs.si:2880 > Accept: application/metalink4+xml > DEBUG Davix: Sending request-line and headers: DEBUG Davix: Request sent; retry is 1. DEBUG Davix: < HTTP/1.1 404 Not Found DEBUG Davix: < Date: Wed, 23 Mar 2022 10:49:19 GMT DEBUG Davix: < Server: dCache/6.2.32 DEBUG Davix: < Content-Type: text/html DEBUG Davix: < Transfer-Encoding: chunked DEBUG Davix: < DEBUG Davix: End of headers. DEBUG Davix: Running post_headers hooks DEBUG Davix: <- negotiateRequest DEBUG Davix: Bad server answer: Content-Length Invalid, impossible to determine answer size DEBUG Davix: NEON Read data flow DEBUG Davix: NEONRequest::readBlock read 0 bytes DEBUG Davix: Running post_send hooks DEBUG Davix: <- executeRequest DEBUG Davix: Parse headers for metalink transfer-encoding chunked DEBUG Davix: Parse headers for metalink date Wed, 23 Mar 2022 10:49:19 GMT DEBUG Davix: Parse headers for metalink server dCache/6.2.32 DEBUG Davix: Parse headers for metalink content-type text/html DEBUG Davix: Destroy HttpRequest DEBUG Davix: Running destroy hooks. DEBUG Davix: Request ends. DEBUG Davix: add old session to cache httpsdcache.ijs.si:2880 INFO Davix: Impossible to Recover with Metalink: Server does not support Metalink standard DEBUG Using client X509 for HTTPS session authorization DEBUG Davix: ssl: Match common name '895748149' against '' DEBUG Davix: Identity match for '': bad DEBUG Davix: ssl: Match common name '895748149' against '' DEBUG Davix: Identity match for '': bad DEBUG Impossible to get string parameter BEARER:TOKEN, set to default value (null), err Key file does not have group “BEARER” DEBUG Impossible to get string parameter BEARER:TOKEN, set to default value (null), err Key file does not have group “BEARER” DEBUG Impossible to get boolean parameter S3:BELLE-DPM-01.NA.INFN.IT:ALTERNATE, set to default value FALSE, err Key file does not have group “S3:BELLE-DPM-01.NA.INFN.IT” DEBUG Impossible to get boolean parameter S3:NA.INFN.IT:ALTERNATE, set to default value FALSE, err Key file does not have group “S3:NA.INFN.IT” DEBUG Impossible to get boolean parameter S3:ALTERNATE, set to default value FALSE, err Key file does not have group “S3” DEBUG Impossible to get string_list parameter HTTP PLUGIN:HEADERS, set to a default value (null), err Key file does not have key “HEADERS” in group “HTTP PLUGIN” DEBUG Impossible to get integer parameter HTTP PLUGIN:OPERATION_TIMEOUT, set to default value 8000, err Key file does not have key “OPERATION_TIMEOUT” in group “HTTP PLUGIN” DEBUG Davix: Create HttpRequest for davs://belle-dpm-01.na.infn.it/dpm/na.infn.it/home/belle/TMP/belle/test/TPC/1G-test?copy_mode=pull DEBUG Davix: ssl: Match common name '895748149' against '' DEBUG Davix: Identity match for '': bad DEBUG Davix: ssl: Match common name '895748149' against '' DEBUG Davix: Identity match for '': bad DEBUG Davix: -> executeRequest DEBUG Davix: creating session keys... httpsbelle-dpm-01.na.infn.it DEBUG Davix: no cached ne_session, create a new one DEBUG Davix: HTTP session to https://belle-dpm-01.na.infn.it:443 begins. DEBUG Davix: ssl: SNI enabled by default. DEBUG Davix: configure session... DEBUG Davix: define connection timeout to 30 DEBUG Davix: define operation timeout to 8000 DEBUG Davix: add CA PATH /etc/grid-security/certificates/ DEBUG Davix: disable login/password authentication DEBUG Davix: enable client cert authentication by callback DEBUG Davix: -> negotiateRequest DEBUG Davix: NEON start internal request DEBUG Davix: Running pre_send hooks DEBUG Davix: > PROPFIND /dpm/na.infn.it/home/belle/TMP/belle/test/TPC/1G-test?copy_mode=pull HTTP/1.1 > User-Agent: gfal2-util/1.6.0 gfal2/2.18.2 neon/0.0.29 > Keep-Alive: > Connection: Keep-Alive > TE: trailers > Host: belle-dpm-01.na.infn.it > Depth: 0 > DEBUG Davix: Sending request-line and headers: DEBUG Davix: Doing DNS lookup on belle-dpm-01.na.infn.it... DEBUG Davix: Doing SSL negotiation. DEBUG Davix: Calling client certificate provider... DEBUG Davix: clicert callback DEBUG Davix: call client cert callback DEBUG Davix: ssl: Match common name '895748149' against '' DEBUG Davix: Identity match for '': bad DEBUG Davix: ssl: Match common name '895748149' against '' DEBUG Davix: Identity match for '': bad DEBUG Davix: Supplying client certificate. DEBUG Davix: Chain depth: 3 DEBUG Davix: ssl: Match common name 'belle-dpm-01.na.infn.it' against '' DEBUG Davix: Identity match for '': bad DEBUG Davix: Cert #0: DEBUG Davix: Certificate: Data: Version: 3 (0x2) Serial Number: b8:a4:95:18:86:f6:01:10:4b:92:81:d9:04:01:7d:9b Signature Algorithm: sha384WithRSAEncryption Issuer: C=NL, O=GEANT Vereniging, CN=GEANT eScience SSL CA 4 Validity Not Before: Feb 10 00:00:00 2022 GMT Not After : Feb 10 23:59:59 2023 GMT Subject: DC=org, DC=terena, DC=tcs, C=IT, ST=Roma, O=Istituto Nazionale di Fisica Nucleare, CN=belle-dpm-01.na.infn.it Subject Public Key Info: Public Key Algorithm: rsaEncryption Public-Key: (2048 bit) Modulus: 00:b2:88:32:cd:27:4d:ec:5c:10:12:ed:14:8b:65: bc:ba:8e:e0:2d:5f:a7:63:b7:b6:01:44:8e:46:f9: cd:09:46:e9:7a:a1:e1:0e:0a:b7:f6:34:82:04:5e: 29:68:68:3b:4f:65:8b:6d:bf:03:4f:88:e8:0a:a1: 3b:7b:f6:fe:a1:c0:32:4e:6d:33:e3:e6:74:8e:c2: 58:26:26:0a:55:f9:8d:91:05:59:d7:8f:66:40:65: e0:c4:7d:8b:d9:b6:f2:a5:b6:0c:00:72:99:84:2e: 4b:dd:df:be:90:26:61:3b:31:e6:1a:31:59:bc:9d: d1:8c:90:af:c9:95:5f:d5:a3:c4:4d:d9:ca:76:50: c0:55:df:13:1e:18:6b:fe:5f:ba:5e:2a:28:bf:c9: ac:27:ff:42:4c:22:23:5a:5a:f0:68:49:5a:dc:9d: 6b:fd:10:a8:ae:7b:3c:eb:30:c3:93:7d:0b:7b:2e: c4:dd:e2:64:30:95:12:e1:98:0d:79:4d:f4:cf:c4: c0:53:af:80:3d:9f:c0:40:ef:43:96:5a:aa:c7:f2: 4a:79:85:3e:fa:ba:8a:ae:2d:d0:84:d0:52:7a:be: b3:03:4a:61:b6:c7:e4:46:5a:0c:bf:48:a1:41:a3: 1d:14:11:d8:80:a5:09:a1:1e:8e:c9:40:22:15:3f: e0:7b Exponent: 65537 (0x10001) X509v3 extensions: X509v3 Authority Key Identifier: keyid:9A:2B:8A:22:D6:8D:0C:C0:2A:A5:6F:64:33:3F:96:60:67:15:1D:B2 X509v3 Subject Key Identifier: 27:7D:5D:DD:FF:79:A6:16:B0:06:7E:99:69:4F:7B:3E:E4:F7:CF:48 X509v3 Key Usage: critical Digital Signature, Key Encipherment X509v3 Basic Constraints: critical CA:FALSE X509v3 Extended Key Usage: TLS Web Server Authentication, TLS Web Client Authentication X509v3 Certificate Policies: Policy: 1.2.840.113612.5.2.2.1 Policy: 1.2.840.113612.5.2.3.3.2 Policy: 1.2.840.113612.5.2.3.1.2 Policy: 1.3.6.1.4.1.6449.1.2.2.79 CPS: https://sectigo.com/CPS Policy: 2.23.140.1.2.2 X509v3 CRL Distribution Points: Full Name: URI:http://GEANT.crl.sectigo.com/GEANTeScienceSSLCA4.crl Authority Information Access: CA Issuers - URI:http://GEANT.crt.sectigo.com/GEANTeScienceSSLCA4.crt OCSP - URI:http://GEANT.ocsp.sectigo.com CT Precertificate SCTs: Signed Certificate Timestamp: Version : v1(0) Log ID : AD:F7:BE:FA:7C:FF:10:C8:8B:9D:3D:9C:1E:3E:18:6A: B4:67:29:5D:CF:B1:0C:24:CA:85:86:34:EB:DC:82:8A Timestamp : Feb 10 16:37:03.963 2022 GMT Extensions: none Signature : ecdsa-with-SHA256 30:44:02:20:17:75:1B:94:C6:AF:C1:F8:64:EC:E5:55: F7:85:91:26:8C:6B:42:D7:9D:91:DA:B6:B0:5A:04:07: C7:4B:66:F5:02:20:34:A4:8D:53:A4:58:A2:14:6D:7B: 3A:C0:57:51:8E:1E:32:18:57:8E:5B:9B:93:2A:B8:C5: F0:86:3D:90:BE:61 Signed Certificate Timestamp: Version : v1(0) Log ID : 7A:32:8C:54:D8:B7:2D:B6:20:EA:38:E0:52:1E:E9:84: 16:70:32:13:85:4D:3B:D2:2B:C1:3A:57:A3:52:EB:52 DEBUG Davix: ssl: Match common name 'GEANT eScience SSL CA 4' against '' DEBUG Davix: Identity match for '': bad DEBUG Davix: Cert #1: DEBUG Davix: Certificate: Data: Version: 3 (0x2) Serial Number: 37:db:9a:38:06:d7:0a:c7:3e:38:d1:df:ef:6e:51:2a Signature Algorithm: sha384WithRSAEncryption Issuer: C=US, ST=New Jersey, L=Jersey City, O=The USERTRUST Network, CN=USERTrust RSA Certification Authority Validity Not Before: Feb 18 00:00:00 2020 GMT Not After : May 1 23:59:59 2033 GMT Subject: C=NL, O=GEANT Vereniging, CN=GEANT eScience SSL CA 4 Subject Public Key Info: Public Key Algorithm: rsaEncryption Public-Key: (4096 bit) Modulus: 00:94:b4:18:5b:cb:91:d9:e1:dc:4d:b2:d4:74:39: ac:45:fd:0a:c2:d0:51:0d:26:6e:7d:35:ae:4b:67: 33:f0:5e:ac:13:75:aa:b5:34:95:19:c0:c2:2b:1d: 35:da:bc:4c:50:a4:6a:b3:76:ac:08:28:d4:b4:96: 2c:8b:91:34:f9:e2:f4:ec:e5:53:e1:e5:26:11:16: d5:40:5f:d3:4b:91:8f:9f:50:8b:b6:89:c3:84:19: fc:25:3d:1e:95:95:8a:7e:92:24:76:56:3e:0e:c1: 88:72:68:cd:2d:8f:ae:ae:69:30:9a:02:3d:d1:cf: df:5d:37:5b:3a:e1:9d:63:c3:fc:23:72:40:8b:6a: df:cc:18:72:f8:72:b2:ae:40:4a:d8:c8:f7:e8:2b: 5b:37:f4:14:7f:81:78:ac:d0:4d:9a:9e:f7:e6:bb: 20:19:dd:80:ce:b0:0c:86:2a:93:e1:12:3d:c3:c6: e8:b3:e7:ea:a9:a8:92:1e:3e:cd:d5:83:29:72:c7: f6:48:a0:91:07:fe:30:2a:bf:b1:9b:75:54:ec:49: fa:b2:32:59:f2:71:e1:74:a7:21:90:e9:8c:e9:d4: 39:0b:c3:80:e0:db:ac:e8:39:27:24:2d:87:88:0a: d4:73:89:2c:33:ac:cb:b7:60:b6:16:54:1e:a1:d6: bd:0d:c3:f8:67:b9:73:18:b7:a5:a0:2d:87:a4:7f: 1b:b0:6a:9c:1b:9e:d6:f0:e6:00:09:a4:ae:b7:81: e0:69:dc:78:fb:6d:69:eb:3d:bf:1a:2e:30:73:7a: eb:40:d9:2b:7e:63:a6:28:75:0f:0f:8d:b8:54:a5: a5:95:30:6c:f3:f9:cd:98:24:af:f1:6f:14:c0:8d: 65:0f:39:d7:7c:70:da:cc:ee:29:5a:3a:bb:db:49: a2:f3:7b:b6:8f:04:55:99:32:98:35:90:eb:da:e4: 9f:75:a9:27:4e:99:2e:39:0c:7c:b2:7d:3e:17:93: 65:ff:dc:78:45:44:b9:0a:03:f7:1d:25:a1:18:13: 52:3f:a7:43:f9:03:6a:85:94:c7:6b:f9:00:f1:ed: 46:ab:e5:9b:ec:6e:fa:e6:d2:09:fe:30:44:75:ba: ad:f1:ba:0a:30:78:2d:e2:7a:01:f0:41:08:78:62: ea:40:11:a9:a8:d6:f3:f2:9f:4e:2b:dd:63:e7:f3: aa:cb:8e:97:b4:38:b1:6f:94:cf:02:42:db:d3:59: 5e:b0:39:7c:b7:1d:39:c8:87:c8:05:1b:17:bf:d1: 6b:b7:5d:80:6d:3d:c2:57:94:13:0e:69:5e:cd:0e: 2e:bd:2c:4f:59:89:83:45:fb:00:59:ea:25:20:57: 0d:d9:45 Exponent: 65537 (0x10001) X509v3 extensions: X509v3 Authority Key Identifier: keyid:53:79:BF:5A:AA:2B:4A:CF:54:80:E1:D8:9B:C0:9D:F2:B2:03:66:CB X509v3 Subject Key Identifier: 9A:2B:8A:22:D6:8D:0C:C0:2A:A5:6F:64:33:3F:96:60:67:15:1D:B2 X509v3 Key Usage: critical Digital Signature, Certificate Sign, CRL Sign X509v3 Basic Constraints: critical CA:TRUE, pathlen:0 X509v3 Extended Key Usage: TLS Web Server Authentication, TLS Web Client Authentication X509v3 Certificate Policies: Policy: X509v3 Any Policy CPS: https://sectigo.com/CPS X509v3 CRL Distribution Points: Full Name: URI:http://crl.usertrust.com/USERTrustRSACertificationAuthority.crl Authority Information Access: CA Issuers - URI:http://crt.usertrust.com/USERTrustRSAAddTrustCA.crt OCSP - URI:http://ocsp.usertrust.com Signature Algorithm: sha384WithRSAEncryption 26:a5:97:13:df:1f:5e:bd:15:68:ee:90:00:b1:d DEBUG Davix: ssl: Match common name 'USERTrust RSA Certification Authority' against '' DEBUG Davix: Identity match for '': bad DEBUG Davix: Cert #2: DEBUG Davix: Certificate: Data: Version: 3 (0x2) Serial Number: 01:fd:6d:30:fc:a3:ca:51:a8:1b:bc:64:0e:35:03:2d Signature Algorithm: sha384WithRSAEncryption Issuer: C=US, ST=New Jersey, L=Jersey City, O=The USERTRUST Network, CN=USERTrust RSA Certification Authority Validity Not Before: Feb 1 00:00:00 2010 GMT Not After : Jan 18 23:59:59 2038 GMT Subject: C=US, ST=New Jersey, L=Jersey City, O=The USERTRUST Network, CN=USERTrust RSA Certification Authority Subject Public Key Info: Public Key Algorithm: rsaEncryption Public-Key: (4096 bit) Modulus: 00:80:12:65:17:36:0e:c3:db:08:b3:d0:ac:57:0d: 76:ed:cd:27:d3:4c:ad:50:83:61:e2:aa:20:4d:09: 2d:64:09:dc:ce:89:9f:cc:3d:a9:ec:f6:cf:c1:dc: f1:d3:b1:d6:7b:37:28:11:2b:47:da:39:c6:bc:3a: 19:b4:5f:a6:bd:7d:9d:a3:63:42:b6:76:f2:a9:3b: 2b:91:f8:e2:6f:d0:ec:16:20:90:09:3e:e2:e8:74: c9:18:b4:91:d4:62:64:db:7f:a3:06:f1:88:18:6a: 90:22:3c:bc:fe:13:f0:87:14:7b:f6:e4:1f:8e:d4: e4:51:c6:11:67:46:08:51:cb:86:14:54:3f:bc:33: fe:7e:6c:9c:ff:16:9d:18:bd:51:8e:35:a6:a7:66: c8:72:67:db:21:66:b1:d4:9b:78:03:c0:50:3a:e8: cc:f0:dc:bc:9e:4c:fe:af:05:96:35:1f:57:5a:b7: ff:ce:f9:3d:b7:2c:b6:f6:54:dd:c8:e7:12:3a:4d: ae:4c:8a:b7:5c:9a:b4:b7:20:3d:ca:7f:22:34:ae: 7e:3b:68:66:01:44:e7:01:4e:46:53:9b:33:60:f7: 94:be:53:37:90:73:43:f3:32:c3:53:ef:db:aa:fe: 74:4e:69:c7:6b:8c:60:93:de:c4:c7:0c:df:e1:32: ae:cc:93:3b:51:78:95:67:8b:ee:3d:56:fe:0c:d0: 69:0f:1b:0f:f3:25:26:6b:33:6d:f7:6e:47:fa:73: 43:e5:7e:0e:a5:66:b1:29:7c:32:84:63:55:89:c4: 0d:c1:93:54:30:19:13:ac:d3:7d:37:a7:eb:5d:3a: 6c:35:5c:db:41:d7:12:da:a9:49:0b:df:d8:80:8a: 09:93:62:8e:b5:66:cf:25:88:cd:84:b8:b1:3f:a4: 39:0f:d9:02:9e:eb:12:4c:95:7c:f3:6b:05:a9:5e: 16:83:cc:b8:67:e2:e8:13:9d:cc:5b:82:d3:4c:b3: ed:5b:ff:de:e5:73:ac:23:3b:2d:00:bf:35:55:74: 09:49:d8:49:58:1a:7f:92:36:e6:51:92:0e:f3:26: 7d:1c:4d:17:bc:c9:ec:43:26:d0:bf:41:5f:40:a9: 44:44:f4:99:e7:57:87:9e:50:1f:57:54:a8:3e:fd: 74:63:2f:b1:50:65:09:e6:58:42:2e:43:1a:4c:b4: f0:25:47:59:fa:04:1e:93:d4:26:46:4a:50:81:b2: de:be:78:b7:fc:67:15:e1:c9:57:84:1e:0f:63:d6: e9:62:ba:d6:5f:55:2e:ea:5c:c6:28:08:04:25:39: b8:0e:2b:a9:f2:4c:97:1c:07:3f:0d:52:f5:ed:ef: 2f:82:0f Exponent: 65537 (0x10001) X509v3 extensions: X509v3 Subject Key Identifier: 53:79:BF:5A:AA:2B:4A:CF:54:80:E1:D8:9B:C0:9D:F2:B2:03:66:CB X509v3 Key Usage: critical Certificate Sign, CRL Sign X509v3 Basic Constraints: critical CA:TRUE Signature Algorithm: sha384WithRSAEncryption 5c:d4:7c:0d:cf:f7:01:7d:41:99:65:0c:73:c5:52:9f:cb:f8: cf:99:06:7f:1b:da:43:15:9f:9e:02:55:57:96:14:f1:52:3c: 27:87:94:28:ed:1f:3a:01:37:a2:76:fc:53:50:c0:84:9b:c6: 6b:4e:ba:8c:21:4f:a2:8e:55:62:91:f3:69:15:d8:bc:88:e3: c4:aa:0b:fd:ef:a8:e9:4b:55:2a:06:20:6d:55:78:29:19:ee: 5f:30:5c:4b:24:11:55:ff:24:9a:6e:5e:2a:2b:ee:0b:4d:9f: 7f:f7:01:38:94:14:95:43:07:09:fb:60:a9:ee:1c:ab:12:8c: a0:9a:5e:a7:98:6a:59:6d:8b:3f:08:fb:c8:d1:45:af:18:15: 64:90:12:0f:73:28:2e:c5:e2:24:4e:fc:58:ec:f0:f4:45:fe: 22:b3:eb:2f:8e:d2:d9:45:61:05:c1:97:6f:a8:76:72:8f:8b: 8c:36:af:bf:0d:05:ce:71:8d:e6:a6:6f:1f:6c:a6:71:62:c5: d8:d0:83:72:0c:f1:67:11:89:0c:9c:13:4c:7 DEBUG Davix: ssl: Match common name 'belle-dpm-01.na.infn.it' against 'belle-dpm-01.na.infn.it' DEBUG Davix: Identity match for 'belle-dpm-01.na.infn.it': good DEBUG Davix: Request sent; retry is 0. DEBUG Davix: < HTTP/1.1 207 Multi-Status DEBUG Davix: < Date: Wed, 23 Mar 2022 10:49:19 GMT DEBUG Davix: < Server: Apache/2.4.6 (CentOS) OpenSSL/1.0.2k-fips DAV/2 mod_gridsite/2.3.4 DEBUG Davix: < Vary: Authorization,User-Agent DEBUG Davix: < Content-Length: 1217 DEBUG Davix: < Keep-Alive: timeout=5, max=100 DEBUG Davix: < Connection: Keep-Alive DEBUG Davix: < Content-Type: text/xml; charset="utf-8" DEBUG Davix: < DEBUG Davix: End of headers. DEBUG Davix: Running post_headers hooks DEBUG Davix: <- negotiateRequest DEBUG Davix: NEON Read data flow DEBUG Davix: Reading 1217 bytes of response body. DEBUG Davix: Got 1217 bytes. DEBUG Davix: NEONRequest::readBlock read 1217 bytes DEBUG Davix: NEON Read data flow DEBUG Davix: NEONRequest::readBlock read 0 bytes DEBUG Davix: Running post_send hooks DEBUG Davix: <- executeRequest DEBUG Davix: XML: Parsing 1218 bytes. DEBUG Davix: XML: start-element (0, {DAV:, multistatus}) => 1 DEBUG Davix: XML: char-data (1) returns 0 DEBUG Davix: XML: start-element (1, {DAV:, response}) => 1 DEBUG Davix: XML: char-data (1) returns 0 DEBUG Davix: XML: start-element (1, {DAV:, href}) => 1 DEBUG Davix: XML: char-data (1) returns 0 DEBUG Davix: href/filename parsed -> 1G-test DEBUG Davix: XML: end-element (1, {DAV:, href}) DEBUG Davix: XML: char-data (1) returns 0 DEBUG Davix: properties detected DEBUG Davix: XML: start-element (1, {DAV:, propstat}) => 1 DEBUG Davix: XML: char-data (1) returns 0 DEBUG Davix: XML: start-element (1, {DAV:, prop}) => 1 DEBUG Davix: XML: char-data (1) returns 0 DEBUG Davix: XML: start-element (1, {LCGDM:, checksum.adler32}) => 1 DEBUG Davix: XML: char-data (1) returns 0 DEBUG Davix: XML: end-element (1, {LCGDM:, checksum.adler32}) DEBUG Davix: XML: start-element (1, {DAV:, resourcetype}) => 1 DEBUG Davix: XML: end-element (1, {DAV:, resourcetype}) DEBUG Davix: XML: char-data (1) returns 0 DEBUG Davix: XML: start-element (1, {DAV:, creationdate}) => 1 DEBUG Davix: XML: char-data (1) returns 0 DEBUG Davix: creationdate found -> parse it DEBUG Davix: creationdate found -> value 1632323128 DEBUG Davix: XML: end-element (1, {DAV:, creationdate}) DEBUG Davix: XML: start-element (1, {DAV:, getlastmodified}) => 1 DEBUG Davix: XML: char-data (1) returns 0 DEBUG Davix: getlastmodified found -> parse it DEBUG Davix: getlastmodified found -> value 1632322914 DEBUG Davix: XML: end-element (1, {DAV:, getlastmodified}) DEBUG Davix: XML: start-element (1, {LCGDM:, lastaccessed}) => 1 DEBUG Davix: XML: char-data (1) returns 0 DEBUG Davix: XML: end-element (1, {LCGDM:, lastaccessed}) DEBUG Davix: XML: start-element (1, {DAV:, getetag}) => 1 DEBUG Davix: XML: char-data (1) returns 0 DEBUG Davix: XML: end-element (1, {DAV:, getetag}) DEBUG Davix: XML: start-element (1, {DAV:, getcontentlength}) => 1 DEBUG Davix: XML: char-data (1) returns 0 DEBUG Davix: content length found -> parse it DEBUG Davix: content length found -> 1072717824 DEBUG Davix: XML: end-element (1, {DAV:, getcontentlength}) DEBUG Davix: XML: start-element (1, {DAV:, displayname}) => 1 DEBUG Davix: XML: char-data (1) returns 0 DEBUG Davix: XML: end-element (1, {DAV:, displayname}) DEBUG Davix: XML: start-element (1, {DAV:, executable}) => 1 DEBUG Davix: XML: char-data (1) returns 0 DEBUG Davix: XML: end-element (1, {DAV:, executable}) DEBUG Davix: XML: start-element (1, {http://apache.org/dav/props/, executable}) => 1 DEBUG Davix: XML: char-data (1) returns 0 DEBUG Davix: XML: end-element (1, {http://apache.org/dav/props/, executable}) DEBUG Davix: XML: start-element (1, {DAV:, iscollection}) => 1 DEBUG Davix: XML: char-data (1) returns 0 DEBUG Davix: XML: end-element (1, {DAV:, iscollection}) DEBUG Davix: XML: start-element (1, {LCGDM:, guid}) => 1 DEBUG Davix: XML: end-element (1, {LCGDM:, guid}) DEBUG Davix: XML: start-element (1, {LCGDM:, mode}) => 1 DEBUG Davix: XML: char-data (1) returns 0 DEBUG Davix: mode_t extension for LCGDM found -> parse it DEBUG Davix: mode_t extension found -> 0100664 DEBUG Davix: XML: end-element (1, {LCGDM:, mode}) DEBUG Davix: XML: start-element (1, {LCGDM:, sumtype}) => 1 DEBUG Davix: XML: char-data (1) returns 0 DEBUG Davix: XML: end-element (1, {LCGDM:, sumtype}) DEBUG Davix: XML: start-element (1, {LCGDM:, sumvalue}) => 1 DEBUG Davix: XML: char-data (1) returns 0 DEBUG Davix: XML: end-element (1, {LCGDM:, sumvalue}) DEBUG Davix: XML: start-element (1, {LCGDM:, fileid}) => 1 DEBUG Davix: XML: char-data (1) returns 0 DEBUG Davix: XML: end-element (1, {LCGDM:, fileid}) DEBUG Davix: XML: start-element (1, {LCGDM:, status}) => 1 DEBUG Davix: XML: char-data (1) returns 0 DEBUG Davix: XML: end-element (1, {LCGDM:, status}) DEBUG Davix: XML: start-element (1, {LCGDM:, xattr}) => 1 DEBUG Davix: XML: char-data (1) returns 0 DEBUG Davix: XML: end-element (1, {LCGDM:, xattr}) DEBUG Davix: XML: start-element (1, {DAV:, owner}) => 1 DEBUG Davix: XML: char-data (1) returns 0 DEBUG Davix: owner found -> parse it DEBUG Davix: owner value : 158 DEBUG Davix: XML: end-element (1, {DAV:, owner}) DEBUG Davix: XML: start-element (1, {DAV:, group}) => 1 DEBUG Davix: XML: char-data (1) returns 0 DEBUG Davix: group found -> parse it DEBUG Davix: group value : 120 DEBUG Davix: XML: end-element (1, {DAV:, group}) DEBUG Davix: XML: end-element (1, {DAV:, prop}) DEBUG Davix: XML: char-data (1) returns 0 DEBUG Davix: XML: start-element (1, {DAV:, status}) => 1 DEBUG Davix: XML: char-data (1) returns 0 DEBUG Davix: status found -> parse it DEBUG Davix: status value : 200 DEBUG Davix: XML: end-element (1, {DAV:, status}) DEBUG Davix: XML: char-data (1) returns 0 DEBUG Davix: end of properties... DEBUG Davix: XML: end-element (1, {DAV:, propstat}) DEBUG Davix: XML: char-data (1) returns 0 DEBUG Davix: XML: end-element (1, {DAV:, response}) DEBUG Davix: XML: char-data (1) returns 0 DEBUG Davix: XML: end-element (1, {DAV:, multistatus}) DEBUG Davix: XML: xmlParseChunk returned 0 DEBUG Davix: Destroy HttpRequest DEBUG Davix: Running destroy hooks. DEBUG Davix: Request ends. DEBUG Davix: add old session to cache httpsbelle-dpm-01.na.infn.it DEBUG Davix: davix_stat <- DEBUG Using client X509 for HTTPS session authorization DEBUG Davix: ssl: Match common name '895748149' against '' DEBUG Davix: Identity match for '': bad DEBUG Davix: ssl: Match common name '895748149' against '' DEBUG Davix: Identity match for '': bad DEBUG Impossible to get string parameter BEARER:TOKEN, set to default value (null), err Key file does not have group “BEARER” DEBUG Impossible to get string parameter BEARER:TOKEN, set to default value (null), err Key file does not have group “BEARER” DEBUG Impossible to get boolean parameter S3:DCACHE.IJS.SI:ALTERNATE, set to default value FALSE, err Key file does not have group “S3:DCACHE.IJS.SI” DEBUG Impossible to get boolean parameter S3:IJS.SI:ALTERNATE, set to default value FALSE, err Key file does not have group “S3:IJS.SI” DEBUG Impossible to get boolean parameter S3:ALTERNATE, set to default value FALSE, err Key file does not have group “S3” DEBUG Impossible to get string_list parameter HTTP PLUGIN:HEADERS, set to a default value (null), err Key file does not have key “HEADERS” in group “HTTP PLUGIN” DEBUG Impossible to get integer parameter HTTP PLUGIN:OPERATION_TIMEOUT, set to default value 8000, err Key file does not have key “OPERATION_TIMEOUT” in group “HTTP PLUGIN” DEBUG Davix: Create HttpRequest for davs://dcache.ijs.si:2880/pnfs/ijs.si/belle/TMP/belle/test/TPC/1G-test-push-Napoli-TMP-SE DEBUG Davix: ssl: Match common name '895748149' against '' DEBUG Davix: Identity match for '': bad DEBUG Davix: ssl: Match common name '895748149' against '' DEBUG Davix: Identity match for '': bad DEBUG Davix: -> executeRequest DEBUG Davix: creating session keys... httpsdcache.ijs.si:2880 DEBUG Davix: cached ne_session found ! taken from cache DEBUG Davix: configure session... DEBUG Davix: define connection timeout to 30 DEBUG Davix: define operation timeout to 8000 DEBUG Davix: add CA PATH /etc/grid-security/certificates/ DEBUG Davix: disable login/password authentication DEBUG Davix: enable client cert authentication by callback DEBUG Davix: -> negotiateRequest DEBUG Davix: NEON start internal request DEBUG Davix: Running pre_send hooks DEBUG Davix: > PROPFIND /pnfs/ijs.si/belle/TMP/belle/test/TPC/1G-test-push-Napoli-TMP-SE HTTP/1.1 > User-Agent: gfal2-util/1.6.0 gfal2/2.18.2 neon/0.0.29 > TE: trailers > Host: dcache.ijs.si:2880 > Depth: 0 > DEBUG Davix: Sending request-line and headers: DEBUG Davix: Request sent; retry is 1. DEBUG Davix: < HTTP/1.1 404 Not Found DEBUG Davix: < Date: Wed, 23 Mar 2022 10:49:19 GMT DEBUG Davix: < Server: dCache/6.2.32 DEBUG Davix: < Content-Type: text/html DEBUG Davix: < Transfer-Encoding: chunked DEBUG Davix: < DEBUG Davix: End of headers. DEBUG Davix: Running post_headers hooks DEBUG Davix: <- negotiateRequest DEBUG Davix: Bad server answer: Content-Length Invalid, impossible to determine answer size DEBUG Davix: NEON Read data flow DEBUG Davix: [chunk] < F0D DEBUG Davix: Got chunk size: 3853 DEBUG Davix: Reading 3853 bytes of response body. DEBUG Davix: Got 3853 bytes. DEBUG Davix: NEONRequest::readBlock read 3853 bytes DEBUG Davix: NEON Read data flow DEBUG Davix: [chunk] < 0 DEBUG Davix: Got chunk size: 0 DEBUG Davix: NEONRequest::readBlock read 0 bytes DEBUG Davix: < DEBUG Davix: End of headers. DEBUG Davix: Running post_send hooks DEBUG Davix: <- executeRequest DEBUG Davix: Destroy HttpRequest DEBUG Davix: Running destroy hooks. DEBUG Davix: Request ends. DEBUG Davix: add old session to cache httpsdcache.ijs.si:2880 INFO Davix: Negative result for operation: HTTP 404 : File not found . After 1 retry INFO Davix: Could not execute operation on davs://dcache.ijs.si:2880/pnfs/ijs.si/belle/TMP/belle/test/TPC/1G-test-push-Napoli-TMP-SE, error Result HTTP 404 : File not found after 1 attempts INFO Davix: Try to Recover with Metalink... DEBUG Davix: Create HttpRequest for davs://dcache.ijs.si:2880/pnfs/ijs.si/belle/TMP/belle/test/TPC/1G-test-push-Napoli-TMP-SE DEBUG Davix: Executing head query to davs://dcache.ijs.si:2880/pnfs/ijs.si/belle/TMP/belle/test/TPC/1G-test-push-Napoli-TMP-SE for Metalink file DEBUG Davix: ssl: Match common name '895748149' against '' DEBUG Davix: Identity match for '': bad DEBUG Davix: ssl: Match common name '895748149' against '' DEBUG Davix: Identity match for '': bad DEBUG Davix: -> executeRequest DEBUG Davix: creating session keys... httpsdcache.ijs.si:2880 DEBUG Davix: cached ne_session found ! taken from cache DEBUG Davix: configure session... DEBUG Davix: define connection timeout to 30 DEBUG Davix: define operation timeout to 8000 DEBUG Davix: add CA PATH /etc/grid-security/certificates/ DEBUG Davix: disable login/password authentication DEBUG Davix: enable client cert authentication by callback DEBUG Davix: -> negotiateRequest DEBUG Davix: NEON start internal request DEBUG Davix: Running pre_send hooks DEBUG Davix: > HEAD /pnfs/ijs.si/belle/TMP/belle/test/TPC/1G-test-push-Napoli-TMP-SE HTTP/1.1 > User-Agent: gfal2-util/1.6.0 gfal2/2.18.2 neon/0.0.29 > TE: trailers > Host: dcache.ijs.si:2880 > Accept: application/metalink4+xml > DEBUG Davix: Sending request-line and headers: DEBUG Davix: Request sent; retry is 1. DEBUG Davix: < HTTP/1.1 404 Not Found DEBUG Davix: < Date: Wed, 23 Mar 2022 10:49:19 GMT DEBUG Davix: < Server: dCache/6.2.32 DEBUG Davix: < Content-Type: text/html DEBUG Davix: < Transfer-Encoding: chunked DEBUG Davix: < DEBUG Davix: End of headers. DEBUG Davix: Running post_headers hooks DEBUG Davix: <- negotiateRequest DEBUG Davix: Bad server answer: Content-Length Invalid, impossible to determine answer size DEBUG Davix: NEON Read data flow DEBUG Davix: NEONRequest::readBlock read 0 bytes DEBUG Davix: Running post_send hooks DEBUG Davix: <- executeRequest DEBUG Davix: Parse headers for metalink transfer-encoding chunked DEBUG Davix: Parse headers for metalink date Wed, 23 Mar 2022 10:49:19 GMT DEBUG Davix: Parse headers for metalink server dCache/6.2.32 DEBUG Davix: Parse headers for metalink content-type text/html DEBUG Davix: Destroy HttpRequest DEBUG Davix: Running destroy hooks. DEBUG Davix: Request ends. DEBUG Davix: add old session to cache httpsdcache.ijs.si:2880 INFO Davix: Impossible to Recover with Metalink: Server does not support Metalink standard Copying 1072717824 bytes davs://belle-dpm-01.na.infn.it/dpm/na.infn.it/home/belle/TMP/belle/test/TPC/1G-test?copy_mode=pull => davs://dcache.ijs.si:2880/pnfs/ijs.si/belle/TMP/belle/test/TPC/1G-test-push-Napoli-TMP-SE DEBUG -> Gfal::Transfer::FileCopy event: [1648032559699] BOTH GFAL2:CORE:COPY LIST:ENTER INFO Event triggered: BOTH GFAL2:CORE:COPY LIST:ENTER event: [1648032559699] BOTH GFAL2:CORE:COPY LIST:ITEM davs://belle-dpm-01.na.infn.it/dpm/na.infn.it/home/belle/TMP/belle/test/TPC/1G-test?copy_mode=pull => davs://dcache.ijs.si:2880/pnfs/ijs.si/belle/TMP/belle/test/TPC/1G-test-push-Napoli-TMP-SE INFO Event triggered: BOTH GFAL2:CORE:COPY LIST:ITEM davs://belle-dpm-01.na.infn.it/dpm/na.infn.it/home/belle/TMP/belle/test/TPC/1G-test?copy_mode=pull => davs://dcache.ijs.si:2880/pnfs/ijs.si/belle/TMP/belle/test/TPC/1G-test-push-Napoli-TMP-SE event: [1648032559699] BOTH GFAL2:CORE:COPY LIST:EXIT INFO Event triggered: BOTH GFAL2:CORE:COPY LIST:EXIT event: [1648032559699] BOTH http_plugin PREPARE:ENTER davs://belle-dpm-01.na.infn.it/dpm/na.infn.it/home/belle/TMP/belle/test/TPC/1G-test?copy_mode=pull => davs://dcache.ijs.si:2880/pnfs/ijs.si/belle/TMP/belle/test/TPC/1G-test-push-Napoli-TMP-SE INFO Event triggered: BOTH http_plugin PREPARE:ENTER davs://belle-dpm-01.na.infn.it/dpm/na.infn.it/home/belle/TMP/belle/test/TPC/1G-test?copy_mode=pull => davs://dcache.ijs.si:2880/pnfs/ijs.si/belle/TMP/belle/test/TPC/1G-test-push-Napoli-TMP-SE DEBUG Using source: davs://belle-dpm-01.na.infn.it/dpm/na.infn.it/home/belle/TMP/belle/test/TPC/1G-test?copy_mode=pull DEBUG Using destination: davs://dcache.ijs.si:2880/pnfs/ijs.si/belle/TMP/belle/test/TPC/1G-test-push-Napoli-TMP-SE DEBUG Using client X509 for HTTPS session authorization DEBUG Davix: ssl: Match common name '895748149' against '' DEBUG Davix: Identity match for '': bad DEBUG Davix: ssl: Match common name '895748149' against '' DEBUG Davix: Identity match for '': bad DEBUG Impossible to get string parameter BEARER:TOKEN, set to default value (null), err Key file does not have group “BEARER” DEBUG Impossible to get string parameter BEARER:TOKEN, set to default value (null), err Key file does not have group “BEARER” DEBUG Impossible to get boolean parameter S3:DCACHE.IJS.SI:ALTERNATE, set to default value FALSE, err Key file does not have group “S3:DCACHE.IJS.SI” DEBUG Impossible to get boolean parameter S3:IJS.SI:ALTERNATE, set to default value FALSE, err Key file does not have group “S3:IJS.SI” DEBUG Impossible to get boolean parameter S3:ALTERNATE, set to default value FALSE, err Key file does not have group “S3” DEBUG Impossible to get string_list parameter HTTP PLUGIN:HEADERS, set to a default value (null), err Key file does not have key “HEADERS” in group “HTTP PLUGIN” DEBUG Impossible to get integer parameter HTTP PLUGIN:OPERATION_TIMEOUT, set to default value 8000, err Key file does not have key “OPERATION_TIMEOUT” in group “HTTP PLUGIN” DEBUG Davix: Create HttpRequest for davs://dcache.ijs.si:2880/pnfs/ijs.si/belle/TMP/belle/test/TPC/1G-test-push-Napoli-TMP-SE DEBUG Davix: ssl: Match common name '895748149' against '' DEBUG Davix: Identity match for '': bad DEBUG Davix: ssl: Match common name '895748149' against '' DEBUG Davix: Identity match for '': bad DEBUG Davix: -> executeRequest DEBUG Davix: creating session keys... httpsdcache.ijs.si:2880 DEBUG Davix: cached ne_session found ! taken from cache DEBUG Davix: configure session... DEBUG Davix: define connection timeout to 30 DEBUG Davix: define operation timeout to 8000 DEBUG Davix: add CA PATH /etc/grid-security/certificates/ DEBUG Davix: disable login/password authentication DEBUG Davix: enable client cert authentication by callback DEBUG Davix: -> negotiateRequest DEBUG Davix: NEON start internal request DEBUG Davix: Running pre_send hooks DEBUG Davix: > PROPFIND /pnfs/ijs.si/belle/TMP/belle/test/TPC/1G-test-push-Napoli-TMP-SE HTTP/1.1 > User-Agent: gfal2-util/1.6.0 gfal2/2.18.2 neon/0.0.29 > TE: trailers > Host: dcache.ijs.si:2880 > Depth: 0 > DEBUG Davix: Sending request-line and headers: DEBUG Davix: Request sent; retry is 1. DEBUG Davix: < HTTP/1.1 404 Not Found DEBUG Davix: < Date: Wed, 23 Mar 2022 10:49:19 GMT DEBUG Davix: < Server: dCache/6.2.32 DEBUG Davix: < Content-Type: text/html DEBUG Davix: < Transfer-Encoding: chunked DEBUG Davix: < DEBUG Davix: End of headers. DEBUG Davix: Running post_headers hooks DEBUG Davix: <- negotiateRequest DEBUG Davix: Bad server answer: Content-Length Invalid, impossible to determine answer size DEBUG Davix: NEON Read data flow DEBUG Davix: [chunk] < F0D DEBUG Davix: Got chunk size: 3853 DEBUG Davix: Reading 3853 bytes of response body. DEBUG Davix: Got 3853 bytes. DEBUG Davix: NEONRequest::readBlock read 3853 bytes DEBUG Davix: NEON Read data flow DEBUG Davix: [chunk] < 0 DEBUG Davix: Got chunk size: 0 DEBUG Davix: NEONRequest::readBlock read 0 bytes DEBUG Davix: < DEBUG Davix: End of headers. DEBUG Davix: Running post_send hooks DEBUG Davix: <- executeRequest DEBUG Davix: Destroy HttpRequest DEBUG Davix: Running destroy hooks. DEBUG Davix: Request ends. DEBUG Davix: add old session to cache httpsdcache.ijs.si:2880 INFO Davix: Negative result for operation: HTTP 404 : File not found . After 1 retry INFO Davix: Could not execute operation on davs://dcache.ijs.si:2880/pnfs/ijs.si/belle/TMP/belle/test/TPC/1G-test-push-Napoli-TMP-SE, error Result HTTP 404 : File not found after 1 attempts INFO Davix: Try to Recover with Metalink... DEBUG Davix: Create HttpRequest for davs://dcache.ijs.si:2880/pnfs/ijs.si/belle/TMP/belle/test/TPC/1G-test-push-Napoli-TMP-SE DEBUG Davix: Executing head query to davs://dcache.ijs.si:2880/pnfs/ijs.si/belle/TMP/belle/test/TPC/1G-test-push-Napoli-TMP-SE for Metalink file DEBUG Davix: ssl: Match common name '895748149' against '' DEBUG Davix: Identity match for '': bad DEBUG Davix: ssl: Match common name '895748149' against '' DEBUG Davix: Identity match for '': bad DEBUG Davix: -> executeRequest DEBUG Davix: creating session keys... httpsdcache.ijs.si:2880 DEBUG Davix: cached ne_session found ! taken from cache DEBUG Davix: configure session... DEBUG Davix: define connection timeout to 30 DEBUG Davix: define operation timeout to 8000 DEBUG Davix: add CA PATH /etc/grid-security/certificates/ DEBUG Davix: disable login/password authentication DEBUG Davix: enable client cert authentication by callback DEBUG Davix: -> negotiateRequest DEBUG Davix: NEON start internal request DEBUG Davix: Running pre_send hooks DEBUG Davix: > HEAD /pnfs/ijs.si/belle/TMP/belle/test/TPC/1G-test-push-Napoli-TMP-SE HTTP/1.1 > User-Agent: gfal2-util/1.6.0 gfal2/2.18.2 neon/0.0.29 > TE: trailers > Host: dcache.ijs.si:2880 > Accept: application/metalink4+xml > DEBUG Davix: Sending request-line and headers: DEBUG Davix: Request sent; retry is 1. DEBUG Davix: < HTTP/1.1 404 Not Found DEBUG Davix: < Date: Wed, 23 Mar 2022 10:49:19 GMT DEBUG Davix: < Server: dCache/6.2.32 DEBUG Davix: < Content-Type: text/html DEBUG Davix: < Transfer-Encoding: chunked DEBUG Davix: < DEBUG Davix: End of headers. DEBUG Davix: Running post_headers hooks DEBUG Davix: <- negotiateRequest DEBUG Davix: Bad server answer: Content-Length Invalid, impossible to determine answer size DEBUG Davix: NEON Read data flow DEBUG Davix: NEONRequest::readBlock read 0 bytes DEBUG Davix: Running post_send hooks DEBUG Davix: <- executeRequest DEBUG Davix: Parse headers for metalink transfer-encoding chunked DEBUG Davix: Parse headers for metalink date Wed, 23 Mar 2022 10:49:19 GMT DEBUG Davix: Parse headers for metalink server dCache/6.2.32 DEBUG Davix: Parse headers for metalink content-type text/html DEBUG Davix: Destroy HttpRequest DEBUG Davix: Running destroy hooks. DEBUG Davix: Request ends. DEBUG Davix: add old session to cache httpsdcache.ijs.si:2880 INFO Davix: Impossible to Recover with Metalink: Server does not support Metalink standard DEBUG Destination does not exist event: [1648032559821] BOTH http_plugin PREPARE:EXIT davs://belle-dpm-01.na.infn.it/dpm/na.infn.it/home/belle/TMP/belle/test/TPC/1G-test?copy_mode=pull => davs://dcache.ijs.si:2880/pnfs/ijs.si/belle/TMP/belle/test/TPC/1G-test-push-Napoli-TMP-SE INFO Event triggered: BOTH http_plugin PREPARE:EXIT davs://belle-dpm-01.na.infn.it/dpm/na.infn.it/home/belle/TMP/belle/test/TPC/1G-test?copy_mode=pull => davs://dcache.ijs.si:2880/pnfs/ijs.si/belle/TMP/belle/test/TPC/1G-test-push-Napoli-TMP-SE INFO Source copy mode is pull event: [1648032559821] BOTH http_plugin TRANSFER:ENTER davs://belle-dpm-01.na.infn.it/dpm/na.infn.it/home/belle/TMP/belle/test/TPC/1G-test?copy_mode=pull => davs://dcache.ijs.si:2880/pnfs/ijs.si/belle/TMP/belle/test/TPC/1G-test-push-Napoli-TMP-SE INFO Event triggered: BOTH http_plugin TRANSFER:ENTER davs://belle-dpm-01.na.infn.it/dpm/na.infn.it/home/belle/TMP/belle/test/TPC/1G-test?copy_mode=pull => davs://dcache.ijs.si:2880/pnfs/ijs.si/belle/TMP/belle/test/TPC/1G-test-push-Napoli-TMP-SE INFO Trying copying with mode 3rd pull event: [1648032559821] BOTH http_plugin TRANSFER:TYPE 3rd pull INFO Event triggered: BOTH http_plugin TRANSFER:TYPE 3rd pull INFO Performing a HTTP third party copy DEBUG Impossible to get string_list parameter HTTP PLUGIN:HEADERS, set to a default value (null), err Key file does not have key “HEADERS” in group “HTTP PLUGIN” DEBUG Impossible to get integer parameter HTTP PLUGIN:OPERATION_TIMEOUT, set to default value 8000, err Key file does not have key “OPERATION_TIMEOUT” in group “HTTP PLUGIN” DEBUG Using client X509 for HTTPS session authorization DEBUG Davix: ssl: Match common name '895748149' against '' DEBUG Davix: Identity match for '': bad DEBUG Davix: ssl: Match common name '895748149' against '' DEBUG Davix: Identity match for '': bad DEBUG Impossible to get string parameter BEARER:TOKEN, set to default value (null), err Key file does not have group “BEARER” DEBUG Impossible to get string parameter BEARER:TOKEN, set to default value (null), err Key file does not have group “BEARER” DEBUG Impossible to get boolean parameter S3:BELLE-DPM-01.NA.INFN.IT:ALTERNATE, set to default value FALSE, err Key file does not have group “S3:BELLE-DPM-01.NA.INFN.IT” DEBUG Impossible to get boolean parameter S3:NA.INFN.IT:ALTERNATE, set to default value FALSE, err Key file does not have group “S3:NA.INFN.IT” DEBUG Impossible to get boolean parameter S3:ALTERNATE, set to default value FALSE, err Key file does not have group “S3” DEBUG Using client X509 for HTTPS session authorization DEBUG Davix: ssl: Match common name '895748149' against '' DEBUG Davix: Identity match for '': bad DEBUG Davix: ssl: Match common name '895748149' against '' DEBUG Davix: Identity match for '': bad DEBUG Impossible to get string parameter BEARER:TOKEN, set to default value (null), err Key file does not have group “BEARER” DEBUG Impossible to get string parameter BEARER:TOKEN, set to default value (null), err Key file does not have group “BEARER” DEBUG Impossible to get boolean parameter S3:DCACHE.IJS.SI:ALTERNATE, set to default value FALSE, err Key file does not have group “S3:DCACHE.IJS.SI” DEBUG Impossible to get boolean parameter S3:IJS.SI:ALTERNATE, set to default value FALSE, err Key file does not have group “S3:IJS.SI” DEBUG Impossible to get boolean parameter S3:ALTERNATE, set to default value FALSE, err Key file does not have group “S3” INFO Davix: Hop: https://dcache.ijs.si:2880/pnfs/ijs.si/belle/TMP/belle/test/TPC/1G-test-push-Napoli-TMP-SE DEBUG Davix: Create HttpRequest for https://dcache.ijs.si:2880/pnfs/ijs.si/belle/TMP/belle/test/TPC/1G-test-push-Napoli-TMP-SE DEBUG Davix: ssl: Match common name '895748149' against '' DEBUG Davix: Identity match for '': bad DEBUG Davix: ssl: Match common name '895748149' against '' DEBUG Davix: Identity match for '': bad DEBUG Davix: creating session keys... httpsdcache.ijs.si:2880 DEBUG Davix: cached ne_session found ! taken from cache DEBUG Davix: configure session... DEBUG Davix: define connection timeout to 30 DEBUG Davix: define operation timeout to 3600 DEBUG Davix: add CA PATH /etc/grid-security/certificates/ DEBUG Davix: disable login/password authentication DEBUG Davix: enable client cert authentication by callback DEBUG Davix: -> negotiateRequest DEBUG Davix: NEON start internal request DEBUG Davix: Running pre_send hooks DEBUG Davix: > COPY /pnfs/ijs.si/belle/TMP/belle/test/TPC/1G-test-push-Napoli-TMP-SE HTTP/1.1 > User-Agent: gfal2-util/1.6.0 gfal2/2.18.2 neon/0.0.29 > TE: trailers > Host: dcache.ijs.si:2880 > Source: https://belle-dpm-01.na.infn.it/dpm/na.infn.it/home/belle/TMP/belle/test/TPC/1G-test?copy_mode=pull > X-Number-Of-Streams: 0 > Secure-Redirection: 1 > Credential: gridsite > RequireChecksumVerification: false > DEBUG Davix: Sending request-line and headers: DEBUG Davix: Request sent; retry is 1. DEBUG Davix: < HTTP/1.1 302 Found DEBUG Davix: < Date: Wed, 23 Mar 2022 10:49:19 GMT DEBUG Davix: < Server: dCache/6.2.32 DEBUG Davix: < X-Delegate-To: https://dcache.ijs.si:8445/srm/delegation DEBUG Davix: < Location: https://dcache.ijs.si:2880/pnfs/ijs.si/belle/TMP/belle/test/TPC/1G-test-push-Napoli-TMP-SE?asked-to-delegate=true DEBUG Davix: < Content-Length: 0 DEBUG Davix: < DEBUG Davix: End of headers. DEBUG Davix: Running post_headers hooks DEBUG Davix: <- negotiateRequest INFO Davix: Got delegation endpoint: https://dcache.ijs.si:8445/srm/delegation INFO Davix: Trying out delegation endpoint: https://dcache.ijs.si:8445/srm/delegation DEBUG Davix: Create HttpRequest for DEBUG Davix: ssl: Match common name '895748149' against '' DEBUG Davix: Identity match for '': bad DEBUG Davix: ssl: Match common name '895748149' against '' DEBUG Davix: Identity match for '': bad DEBUG Davix: Destroy HttpRequest DEBUG Davix: ssl: Match common name '895748149' against '' DEBUG Davix: Identity match for '': bad