Unified Manager file restore from snapshot fails
Applies to
- Unified Manager 9.x (UM 9.x)
- ONTAP 9
Issue
- when restoring a file from a remote backup volume snapshot or generally a file from shapshot to a different cluster it fails
- mostly there is an error after 5 minutes which is the UM ndmp timeout
- restoring a file from local snapshot to same or different location on the same cluster does work
- ndmp restore (which UM utilizes) does work on cli using ndmpcopy command
Name:ndmp-connect(172.10.10.10, 10.10.10.10)
Description:Establish NDMP session with source 172.10.10.10 using login name svc_na_ocum and destination 10.10.10.10 using login name svc_na_ocum.
Failure Reason:Invalid output from the cluster 'cluster_name', CLI: 'Storage Virtual Machine services ndmp show -Storage Virtual Machine cluster_name'. Output: ''.
Name:ndmp-copy-prepare
Description:Prepare source 10.11.11.11 and destination 10.10.10.10 for NDMP copy operation.
Failure Reason:com.netapp.ndmp.NdmpException: com.netapp.ndmp.NdmpMessageException: Error code in NDMP message: NDMP_CONNECT_ERR
Name:ndmp-copy-prepare
Description:Prepare source 172.12.12.12 and destination 10.10.10.10 for NDMP copy operation.
Failure Reason:com.netapp.ndmp.NdmpException: com.netapp.ndmp.NdmpMessageException: Error code in NDMP message: NDMP_CONNECT_ERR
00000014.00666c7b 045e95fc Wed May 05 2021 15:38:54 +02:00 [kern_ndmpd:info:34576] [12594] DEBUG: Create buf stream for IPC read fd=15 ([10.10.10.10].46634)
00000014.00666c7c 045e95fc Wed May 05 2021 15:38:54 +02:00 [kern_ndmpd:info:34576] [12594] DEBUG: ndmp_io_process: v0 protocol
00000014.00666c7d 045e95fc Wed May 05 2021 15:38:54 +02:00 [kern_ndmpd:info:34576] [12594] DEBUG: ndmp_io_process: v0 server connect
00000014.00666c7e 045e95fc Wed May 05 2021 15:38:54 +02:00 [kern_ndmpd:info:34576] [12594] DEBUG: DMA<<S V0 Sequence=1
00000014.00666c7f 045e95fc Wed May 05 2021 15:38:54 +02:00 [kern_ndmpd:info:34576] [12594] DEBUG: Time_stamp=0x60929fee (May 5 15:38:54 2021)
00000014.00666c80 045e95fc Wed May 05 2021 15:38:54 +02:00 [kern_ndmpd:info:34576] [12594] DEBUG: Message type=0 (NDMP0_REQUEST)
00000014.00666c81 045e95fc Wed May 05 2021 15:38:54 +02:00 [kern_ndmpd:info:34576] [12594] DEBUG: Message procedure=0x502 (NDMP0_NOTIFY_CONNECTED)
00000014.00666c82 045e95fc Wed May 05 2021 15:38:54 +02:00 [kern_ndmpd:info:34576] [12594] DEBUG: Reply sequence=0
00000014.00666c83 045e95fc Wed May 05 2021 15:38:54 +02:00 [kern_ndmpd:info:34576] [12594] DEBUG: Error=0 (NDMP0_NO_ERR)
00000014.00666c84 045e95fc Wed May 05 2021 15:38:54 +02:00 [kern_ndmpd:info:34576] [12594] DEBUG: reason=0 (NDMP0_CONNECTED)
00000014.00666c85 045e95fc Wed May 05 2021 15:38:54 +02:00 [kern_ndmpd:info:34576] [12594] DEBUG: protocol_version=4
00000014.00666c86 045e95fc Wed May 05 2021 15:38:54 +02:00 [kern_ndmpd:info:34576] [12594] DEBUG: text_reason='Connection successful'
00000014.00666e29 045ea1c2 Wed May 05 2021 15:43:54 +02:00 [kern_ndmpd:info:34576] [12594] DEBUG: Time_Out::next timeout 1620222534.658735
00000014.00666e2a 045ea1c2 Wed May 05 2021 15:43:55 +02:00 [kern_ndmpd:info:34576] [12594] DEBUG: DMA>>S V4 sequence=9 (0x9)
00000014.00666e2b 045ea1c2 Wed May 05 2021 15:43:55 +02:00 [kern_ndmpd:info:34576] [12594] DEBUG: Time_stamp=0x6092a131 (May 5 15:44:17 2021)
00000014.00666e2c 045ea1c2 Wed May 05 2021 15:43:55 +02:00 [kern_ndmpd:info:34576] [12594] DEBUG: message type=0 (NDMP4_MESSAGE_REQUEST)
00000014.00666e2d 045ea1c2 Wed May 05 2021 15:43:55 +02:00 [kern_ndmpd:info:34576] [12594] DEBUG: message_code=0x407 (NDMP4_DATA_STOP)
00000014.00666e2e 045ea1c2 Wed May 05 2021 15:43:55 +02:00 [kern_ndmpd:info:34576] [12594] DEBUG: reply_sequence=10 (0xa)
00000014.00666e2f 045ea1c2 Wed May 05 2021 15:43:55 +02:00 [kern_ndmpd:info:34576] [12594] DEBUG: error_code=0 (NDMP4_NO_ERR)
00000014.00666e30 045ea1c2 Wed May 05 2021 15:43:55 +02:00 [kern_ndmpd:info:34576] [12594] DEBUG: DATA data stop: called