When I run a DCP job, DCP-O-Matic fails.
Before I begin a DCP job, I reboot the computer. There is no network connectivity, and no other applications are running.
The job begins and runs. I takes a long time so I leave the computer running.
At some point I return and DCP-O-Matic closes. No error message is displayed.
There's a partially rendered DCP that won't play, so the assumption is that the application crashed during the job.
The DCP-O-Matic version number is: 2.16.72.
Is there an error log I can look at to troubleshoot?
Any suggestions would be helpful.
Thanks for looking!
DCP Job Fails Without Error Message
-
- Site Admin
- Posts: 2550
- Joined: Thu Nov 14, 2013 2:53 pm
Re: DCP Job Fails Without Error Message
There is a file called log inside the project folder. Is this Mac or windows?
-
- Posts: 3
- Joined: Thu Feb 22, 2024 2:45 pm
Re: DCP Job Fails Without Error Message
Hi Carl. Thanks for the reply.
It's a Windows system.
Here's the log:
21/02/2024 07:56:18: Sub-job Computing digest starting
21/02/2024 07:56:18: Temporal reference was T2T2T2T2T2T2T2T2T2T2T2T2T2T2T2T2
21/02/2024 07:56:18: Video length obtained from header as 62129 frames
21/02/2024 07:56:18: New graph for 1280x1080, pixel format 0
21/02/2024 07:56:18: Creating new resampler from 48000 to 47952 with 6 channels
21/02/2024 07:56:18: FFmpeg: Warning: data is not aligned! This can lead to a speed loss
21/02/2024 07:56:19: New graph for 1280x1080, pixel format 0
21/02/2024 07:56:19: New graph for 1280x1080, pixel format 0
21/02/2024 07:56:38: Could not open existing asset at E:\_Export\DCP Export\Winchester Place - 01 & 14 (5.1) H.264 29.97 Frame Sampling 19Feb2024\Winchester Place - 01 & 14 (5.1) H.264 29.97 Frame Sampling 19Feb2024\video\185_2K_728f782bf3a534ab43a3e1e3815363fe_30_150000000_P_S_L21_0_198812800.mxf (errno=2)
21/02/2024 07:56:38: Creating new resampler from 48000 to 47952 with 6 channels
21/02/2024 07:56:42: Finishing ReelWriters
21/02/2024 07:56:42: Nothing was written to reel 0 of 1
21/02/2024 07:56:42: Writing XML
21/02/2024 07:56:42: create_reel for 0-198812800; 0 of 1
21/02/2024 07:56:43: Wrote 0 FULL, 0 FAKE, 0 REPEAT, 0 pushed to disk
21/02/2024 07:56:43: DCP-o-matic 2.16.72 git 9af65a1ea0 using libavcodec 58.134.100, libavfilter 7.110.100, libavformat 58.76.100, libavutil 56.70.100, libswscale 5.9.100, libssh 0.9.1/gnutls/zlib, libdcp 1.8.94 git c9b3af92c4
21/02/2024 07:56:43: Host name JoeG
21/02/2024 07:56:43: DCP-o-matic built in optimised mode.
21/02/2024 07:56:43: libdcp built in optimised mode.
21/02/2024 07:56:43: Windows version 6.2.9200
21/02/2024 07:56:43: Windows 8 or Windows Server 2012
21/02/2024 07:56:43: Built for x86 64-bit
21/02/2024 07:56:43: CPU: Intel(R) Core(TM) i9-9980HK CPU @ 2.40GHz
21/02/2024 07:56:43: Content: Winchester Place - 01 & 14 (5.1) H.264 29.97 Frame Sampling 19Feb2024.mp4 2b10281339f93467c0ad6dcb347b7c372788467833 0 29.97002997002997 - video: length 62129 frames, size 1280x1080, sample aspect ratio 1.5 - audio: stream channels 6 rate 48000 ffmpeg: audio id 2 subtitle none filters
21/02/2024 07:56:43: DCP video rate 30 fps
21/02/2024 07:56:43: 16 threads
21/02/2024 07:56:43: J2K bandwidth 150000000
21/02/2024 07:56:43: Sub-job Checking existing image data starting
21/02/2024 07:56:43: Could not open existing asset at E:\_Export\DCP Export\Winchester Place - 01 & 14 (5.1) H.264 29.97 Frame Sampling 19Feb2024\Winchester Place - 01 & 14 (5.1) H.264 29.97 Frame Sampling 19Feb2024\video\185_2K_728f782bf3a534ab43a3e1e3815363fe_30_150000000_P_S_L21_0_198812800.mxf (errno=2)
21/02/2024 07:56:43: Transcode job starting
21/02/2024 07:56:43: Sub-job Encoding starting
21/02/2024 07:56:43: New graph for 1280x1080, pixel format 0
21/02/2024 07:56:43: Creating new resampler from 48000 to 47952 with 6 channels
21/02/2024 07:56:49: Frame 58 encoded size was small (8767); adding noise at level 2 with pixel skip 16
21/02/2024 07:56:49: Frame 152 encoded size was small (10355); adding noise at level 2 with pixel skip 16
21/02/2024 08:13:25: Frame 8770 encoded size was small (8767); adding noise at level 2 with pixel skip 16
21/02/2024 08:13:25: Frame 8771 encoded size was small (9104); adding noise at level 2 with pixel skip 16
21/02/2024 08:24:37: Frame 15160 encoded size was small (9339); adding noise at level 2 with pixel skip 16
21/02/2024 08:24:37: Frame 15183 encoded size was small (8767); adding noise at level 2 with pixel skip 16
21/02/2024 08:27:26: Frame 16546 encoded size was small (8767); adding noise at level 2 with pixel skip 16
21/02/2024 08:29:22: Frame 17699 encoded size was small (1318); adding noise at level 2 with pixel skip 16
21/02/2024 08:29:36: Frame 18197 encoded size was small (1806); adding noise at level 2 with pixel skip 16
21/02/2024 08:29:36: Frame 18221 encoded size was small (1318); adding noise at level 2 with pixel skip 16
21/02/2024 09:00:56: Frame 33435 encoded size was small (8767); adding noise at level 2 with pixel skip 16
21/02/2024 09:08:27: Frame 37089 encoded size was small (8767); adding noise at level 2 with pixel skip 16
21/02/2024 09:08:27: Frame 37111 encoded size was small (9833); adding noise at level 2 with pixel skip 16
21/02/2024 09:13:10: Frame 39751 encoded size was small (12391); adding noise at level 2 with pixel skip 16
21/02/2024 09:13:10: Frame 39752 encoded size was small (11295); adding noise at level 2 with pixel skip 16
21/02/2024 09:13:10: Frame 39757 encoded size was small (8767); adding noise at level 2 with pixel skip 16
21/02/2024 09:20:18: Frame 43408 encoded size was small (8767); adding noise at level 2 with pixel skip 16
21/02/2024 09:20:18: Frame 43412 encoded size was small (11758); adding noise at level 2 with pixel skip 16
21/02/2024 09:44:09: Frame 55059 encoded size was small (8767); adding noise at level 2 with pixel skip 16
21/02/2024 09:44:09: Frame 55165 encoded size was small (14179); adding noise at level 2 with pixel skip 16
21/02/2024 09:51:48: Frame 58707 encoded size was small (10304); adding noise at level 2 with pixel skip 16
21/02/2024 09:51:49: Frame 58708 encoded size was small (10442); adding noise at level 2 with pixel skip 16
21/02/2024 09:51:49: Frame 58709 encoded size was small (10120); adding noise at level 2 with pixel skip 16
21/02/2024 09:51:49: Frame 58721 encoded size was small (8767); adding noise at level 2 with pixel skip 16
21/02/2024 09:55:11: Clearing queue of 31
21/02/2024 09:55:15: Terminating encoder threads
21/02/2024 09:55:16: Frame 62127 encoded size was small (1318); adding noise at level 2 with pixel skip 16
21/02/2024 09:55:16: Mopping up 0
21/02/2024 09:55:17: Terminating writer thread
21/02/2024 09:55:17: Finishing ReelWriters
21/02/2024 09:55:17: WARNING: Hard-link failed (system:1:Incorrect function); copying instead
21/02/2024 09:55:17: Sub-job Copying video file into DCP starting
21/02/2024 09:58:34: Writing XML
21/02/2024 09:58:34: Sub-job Computing digests starting
It's a Windows system.
Here's the log:
21/02/2024 07:56:18: Sub-job Computing digest starting
21/02/2024 07:56:18: Temporal reference was T2T2T2T2T2T2T2T2T2T2T2T2T2T2T2T2
21/02/2024 07:56:18: Video length obtained from header as 62129 frames
21/02/2024 07:56:18: New graph for 1280x1080, pixel format 0
21/02/2024 07:56:18: Creating new resampler from 48000 to 47952 with 6 channels
21/02/2024 07:56:18: FFmpeg: Warning: data is not aligned! This can lead to a speed loss
21/02/2024 07:56:19: New graph for 1280x1080, pixel format 0
21/02/2024 07:56:19: New graph for 1280x1080, pixel format 0
21/02/2024 07:56:38: Could not open existing asset at E:\_Export\DCP Export\Winchester Place - 01 & 14 (5.1) H.264 29.97 Frame Sampling 19Feb2024\Winchester Place - 01 & 14 (5.1) H.264 29.97 Frame Sampling 19Feb2024\video\185_2K_728f782bf3a534ab43a3e1e3815363fe_30_150000000_P_S_L21_0_198812800.mxf (errno=2)
21/02/2024 07:56:38: Creating new resampler from 48000 to 47952 with 6 channels
21/02/2024 07:56:42: Finishing ReelWriters
21/02/2024 07:56:42: Nothing was written to reel 0 of 1
21/02/2024 07:56:42: Writing XML
21/02/2024 07:56:42: create_reel for 0-198812800; 0 of 1
21/02/2024 07:56:43: Wrote 0 FULL, 0 FAKE, 0 REPEAT, 0 pushed to disk
21/02/2024 07:56:43: DCP-o-matic 2.16.72 git 9af65a1ea0 using libavcodec 58.134.100, libavfilter 7.110.100, libavformat 58.76.100, libavutil 56.70.100, libswscale 5.9.100, libssh 0.9.1/gnutls/zlib, libdcp 1.8.94 git c9b3af92c4
21/02/2024 07:56:43: Host name JoeG
21/02/2024 07:56:43: DCP-o-matic built in optimised mode.
21/02/2024 07:56:43: libdcp built in optimised mode.
21/02/2024 07:56:43: Windows version 6.2.9200
21/02/2024 07:56:43: Windows 8 or Windows Server 2012
21/02/2024 07:56:43: Built for x86 64-bit
21/02/2024 07:56:43: CPU: Intel(R) Core(TM) i9-9980HK CPU @ 2.40GHz
21/02/2024 07:56:43: Content: Winchester Place - 01 & 14 (5.1) H.264 29.97 Frame Sampling 19Feb2024.mp4 2b10281339f93467c0ad6dcb347b7c372788467833 0 29.97002997002997 - video: length 62129 frames, size 1280x1080, sample aspect ratio 1.5 - audio: stream channels 6 rate 48000 ffmpeg: audio id 2 subtitle none filters
21/02/2024 07:56:43: DCP video rate 30 fps
21/02/2024 07:56:43: 16 threads
21/02/2024 07:56:43: J2K bandwidth 150000000
21/02/2024 07:56:43: Sub-job Checking existing image data starting
21/02/2024 07:56:43: Could not open existing asset at E:\_Export\DCP Export\Winchester Place - 01 & 14 (5.1) H.264 29.97 Frame Sampling 19Feb2024\Winchester Place - 01 & 14 (5.1) H.264 29.97 Frame Sampling 19Feb2024\video\185_2K_728f782bf3a534ab43a3e1e3815363fe_30_150000000_P_S_L21_0_198812800.mxf (errno=2)
21/02/2024 07:56:43: Transcode job starting
21/02/2024 07:56:43: Sub-job Encoding starting
21/02/2024 07:56:43: New graph for 1280x1080, pixel format 0
21/02/2024 07:56:43: Creating new resampler from 48000 to 47952 with 6 channels
21/02/2024 07:56:49: Frame 58 encoded size was small (8767); adding noise at level 2 with pixel skip 16
21/02/2024 07:56:49: Frame 152 encoded size was small (10355); adding noise at level 2 with pixel skip 16
21/02/2024 08:13:25: Frame 8770 encoded size was small (8767); adding noise at level 2 with pixel skip 16
21/02/2024 08:13:25: Frame 8771 encoded size was small (9104); adding noise at level 2 with pixel skip 16
21/02/2024 08:24:37: Frame 15160 encoded size was small (9339); adding noise at level 2 with pixel skip 16
21/02/2024 08:24:37: Frame 15183 encoded size was small (8767); adding noise at level 2 with pixel skip 16
21/02/2024 08:27:26: Frame 16546 encoded size was small (8767); adding noise at level 2 with pixel skip 16
21/02/2024 08:29:22: Frame 17699 encoded size was small (1318); adding noise at level 2 with pixel skip 16
21/02/2024 08:29:36: Frame 18197 encoded size was small (1806); adding noise at level 2 with pixel skip 16
21/02/2024 08:29:36: Frame 18221 encoded size was small (1318); adding noise at level 2 with pixel skip 16
21/02/2024 09:00:56: Frame 33435 encoded size was small (8767); adding noise at level 2 with pixel skip 16
21/02/2024 09:08:27: Frame 37089 encoded size was small (8767); adding noise at level 2 with pixel skip 16
21/02/2024 09:08:27: Frame 37111 encoded size was small (9833); adding noise at level 2 with pixel skip 16
21/02/2024 09:13:10: Frame 39751 encoded size was small (12391); adding noise at level 2 with pixel skip 16
21/02/2024 09:13:10: Frame 39752 encoded size was small (11295); adding noise at level 2 with pixel skip 16
21/02/2024 09:13:10: Frame 39757 encoded size was small (8767); adding noise at level 2 with pixel skip 16
21/02/2024 09:20:18: Frame 43408 encoded size was small (8767); adding noise at level 2 with pixel skip 16
21/02/2024 09:20:18: Frame 43412 encoded size was small (11758); adding noise at level 2 with pixel skip 16
21/02/2024 09:44:09: Frame 55059 encoded size was small (8767); adding noise at level 2 with pixel skip 16
21/02/2024 09:44:09: Frame 55165 encoded size was small (14179); adding noise at level 2 with pixel skip 16
21/02/2024 09:51:48: Frame 58707 encoded size was small (10304); adding noise at level 2 with pixel skip 16
21/02/2024 09:51:49: Frame 58708 encoded size was small (10442); adding noise at level 2 with pixel skip 16
21/02/2024 09:51:49: Frame 58709 encoded size was small (10120); adding noise at level 2 with pixel skip 16
21/02/2024 09:51:49: Frame 58721 encoded size was small (8767); adding noise at level 2 with pixel skip 16
21/02/2024 09:55:11: Clearing queue of 31
21/02/2024 09:55:15: Terminating encoder threads
21/02/2024 09:55:16: Frame 62127 encoded size was small (1318); adding noise at level 2 with pixel skip 16
21/02/2024 09:55:16: Mopping up 0
21/02/2024 09:55:17: Terminating writer thread
21/02/2024 09:55:17: Finishing ReelWriters
21/02/2024 09:55:17: WARNING: Hard-link failed (system:1:Incorrect function); copying instead
21/02/2024 09:55:17: Sub-job Copying video file into DCP starting
21/02/2024 09:58:34: Writing XML
21/02/2024 09:58:34: Sub-job Computing digests starting
Last edited by Joe.G on Thu Feb 22, 2024 3:58 pm, edited 1 time in total.
-
- Site Admin
- Posts: 2550
- Joined: Thu Nov 14, 2013 2:53 pm
Re: DCP Job Fails Without Error Message
Does this happen every time you run the same job? (It should go quicker after the first time).
-
- Posts: 3
- Joined: Thu Feb 22, 2024 2:45 pm
Re: DCP Job Fails Without Error Message
The failure occurred two or three times with the exact same job.
I tried something different today as a troubleshooting test.
The DCP title had an ampersand "&" character.
I removed the "&" from the title during the next job and the job finished successfully.
Has there been any reports about use of unusual characters causing errors?
I'll continue testing and report any new findings.
I tried something different today as a troubleshooting test.
The DCP title had an ampersand "&" character.
I removed the "&" from the title during the next job and the job finished successfully.
Has there been any reports about use of unusual characters causing errors?
I'll continue testing and report any new findings.
-
- Posts: 2806
- Joined: Tue Apr 15, 2014 9:11 pm
- Location: Germany
Re: DCP Job Fails Without Error Message
Never use special chars in DCP titles and transport folders/media path names. DCP-o-matic should catch it normally, but still, don't push it.
-
- Site Admin
- Posts: 2550
- Joined: Thu Nov 14, 2013 2:53 pm
Re: DCP Job Fails Without Error Message
I haven't heard of problems with & (and I just tried it quickly and it seemed OK).
Sadly DCP-o-matic's crash logging on Windows is quite poor, but if you have time we can try adding some tools to find out more about the crash. Would you be able to do a debugging session over Zoom (or similar)?
Sadly DCP-o-matic's crash logging on Windows is quite poor, but if you have time we can try adding some tools to find out more about the crash. Would you be able to do a debugging session over Zoom (or similar)?
-
- Posts: 3
- Joined: Thu Feb 22, 2024 2:45 pm
Re: DCP Job Fails Without Error Message
Hi Carl,
If you can send me a link to the tools and the installation instructions, we can do some testing.
Thanks!
If you can send me a link to the tools and the installation instructions, we can do some testing.
Thanks!
-
- Site Admin
- Posts: 2550
- Joined: Thu Nov 14, 2013 2:53 pm
Re: DCP Job Fails Without Error Message
Great! First I'd like to try "Dr. MinGW", for which I think you need to follow these steps:
- Download the software.
- Unpack it somewhere.
- Open a command window with administrator privileges and go into the unpacked folder.
- Type drmingw -i to install.