docker-makemkv icon indicating copy to clipboard operation
docker-makemkv copied to clipboard

Auto Disk Ripper extremly slow

Open leuchtrakete666 opened this issue 3 years ago • 22 comments

i encountered some interesting phenomena. when using the docker with the gui and no autodiskripper the dvd or bluray rips fast, at full speed of the drive. with autodiskripper its slow, very slow. it takes ages to process the titles, decrypt the disk and the ripping itself is about 2-5 times slower than with the docker gui.

i have many, about 2000+ dvds and blurays to rip. for this i get 5 dvd and 3 bluray writer. the bluray writers are patched to rip uhd disks. so it would be great to get this running. the drives are all hitachi lg. my cpu is strong enough with 6 cores and 12 threads at 3,5 hz and memory on my server is 48gb. and i plan to add 1 additional bluray and 7 dvd writer. all connected with usb 3 on 2 powered usb hubs with the capability to deliver 900mA on each port. the drives get enough power through a Y cable. the cable from the dock to the server is a high quality usb3 cable and 2,5 m long. from my point of view, the setup is good.

thanks for help.

2021-12-19T16:17:09.330966671Z [s6-init] making user provided files available at /var/run/s6/etc...exited 0.
2021-12-19T16:17:09.376026839Z [s6-init] ensuring user provided files have correct perms...exited 0.
2021-12-19T16:17:09.377554423Z [fix-attrs.d] applying ownership & permissions fixes...
2021-12-19T16:17:09.379015048Z [fix-attrs.d] done.
2021-12-19T16:17:09.380081214Z [cont-init.d] executing container initialization scripts...
2021-12-19T16:17:09.381571964Z [cont-init.d] 00-app-niceness.sh: executing... 
2021-12-19T16:17:09.387706715Z [cont-init.d] 00-app-niceness.sh: exited 0.
2021-12-19T16:17:09.388723631Z [cont-init.d] 00-app-script.sh: executing... 
2021-12-19T16:17:14.450098717Z [cont-init.d] 00-app-script.sh: exited 0.
2021-12-19T16:17:14.453101134Z [cont-init.d] 00-app-user-map.sh: executing... 
2021-12-19T16:17:14.474434218Z [cont-init.d] 00-app-user-map.sh: exited 0.
2021-12-19T16:17:14.477471010Z [cont-init.d] 00-clean-logmonitor-states.sh: executing... 
2021-12-19T16:17:14.488324510Z [cont-init.d] 00-clean-logmonitor-states.sh: exited 0.
2021-12-19T16:17:14.491390135Z [cont-init.d] 00-clean-tmp-dir.sh: executing... 
2021-12-19T16:17:14.502476053Z [cont-init.d] 00-clean-tmp-dir.sh: exited 0.
2021-12-19T16:17:14.505528803Z [cont-init.d] 00-set-app-deps.sh: executing... 
2021-12-19T16:17:14.536462096Z [cont-init.d] 00-set-app-deps.sh: exited 0.
2021-12-19T16:17:14.539552596Z [cont-init.d] 00-set-home.sh: executing... 
2021-12-19T16:17:14.548964263Z [cont-init.d] 00-set-home.sh: exited 0.
2021-12-19T16:17:14.551940055Z [cont-init.d] 00-take-config-ownership.sh: executing... 
2021-12-19T16:17:14.566353139Z [cont-init.d] 00-take-config-ownership.sh: exited 0.
2021-12-19T16:17:14.569422805Z [cont-init.d] 00-xdg-runtime-dir.sh: executing... 
2021-12-19T16:17:14.586257264Z [cont-init.d] 00-xdg-runtime-dir.sh: exited 0.
2021-12-19T16:17:14.589433223Z [cont-init.d] 10-certs.sh: executing... 
2021-12-19T16:17:14.598753890Z [cont-init.d] 10-certs.sh: exited 0.
2021-12-19T16:17:14.601829140Z [cont-init.d] 10-cjk-font.sh: executing... 
2021-12-19T16:17:14.611538640Z [cont-init.d] 10-cjk-font.sh: exited 0.
2021-12-19T16:17:14.614626391Z [cont-init.d] 10-nginx.sh: executing... 
2021-12-19T16:17:14.683719268Z [cont-init.d] 10-nginx.sh: exited 0.
2021-12-19T16:17:14.686188227Z [cont-init.d] 10-vnc-password.sh: executing... 
2021-12-19T16:17:14.694200227Z [cont-init.d] 10-vnc-password.sh: exited 0.
2021-12-19T16:17:14.696314602Z [cont-init.d] 10-web-index.sh: executing... 
2021-12-19T16:17:14.713644145Z [cont-init.d] 10-web-index.sh: exited 0.
2021-12-19T16:17:14.715967311Z [cont-init.d] 90-makemkv.sh: executing... 
2021-12-19T16:17:14.722607853Z [cont-init.d] 90-makemkv.sh: generating machine-id...
2021-12-19T16:17:14.726667062Z app_ccextractor = "/opt/makemkv/bin/mmccextr"
2021-12-19T16:17:14.733249312Z Registration key already up-to-date.
2021-12-19T16:17:14.775164814Z [cont-init.d] 90-makemkv.sh: exited 0.
2021-12-19T16:17:14.777567022Z [cont-init.d] 95-check-optical-drive.sh: executing... 
2021-12-19T16:17:14.784075356Z [cont-init.d] 95-check-optical-drive.sh: looking for usable optical drives...
2021-12-19T16:17:14.798941732Z [cont-init.d] 95-check-optical-drive.sh: found optical drive [/dev/sr4, /dev/sg17], group 24.
2021-12-19T16:17:14.806371190Z [cont-init.d] 95-check-optical-drive.sh: found optical drive [/dev/sr5, /dev/sg18], group 24.
2021-12-19T16:17:14.813494107Z [cont-init.d] 95-check-optical-drive.sh: found optical drive [/dev/sr6, /dev/sg19], group 24.
2021-12-19T16:17:14.820820149Z [cont-init.d] 95-check-optical-drive.sh: found optical drive [/dev/sr7, /dev/sg20], group 24.
2021-12-19T16:17:14.828176233Z [cont-init.d] 95-check-optical-drive.sh: found optical drive [/dev/sr8, /dev/sg21], group 24.
2021-12-19T16:17:14.835802400Z [cont-init.d] 95-check-optical-drive.sh: found optical drive [/dev/sr9, /dev/sg22], group 24.
2021-12-19T16:17:14.843121650Z [cont-init.d] 95-check-optical-drive.sh: found optical drive [/dev/sr10, /dev/sg23], group 24.
2021-12-19T16:17:14.850322234Z [cont-init.d] 95-check-optical-drive.sh: found optical drive [/dev/sr11, /dev/sg24], group 24.
2021-12-19T16:17:14.855780442Z [cont-init.d] 95-check-optical-drive.sh: exited 0.
2021-12-19T16:17:14.857926776Z [cont-init.d] 96-install-autodiscripper-srv.sh: executing... 
2021-12-19T16:17:24.507270219Z [cont-init.d] 96-install-autodiscripper-srv.sh: installing automatic disc ripper for drive 0 (DVD+R-DL HL-DT-ST DVDRAM GP60NB60 RF01 K0HL67A2448)...
2021-12-19T16:17:24.625767724Z [cont-init.d] 96-install-autodiscripper-srv.sh: installing automatic disc ripper for drive 1 (BD-RE HL-DT-ST BD-RE BP55EB40 1.03 SIK04L9GG5716)...
2021-12-19T16:17:24.632329766Z [cont-init.d] 96-install-autodiscripper-srv.sh: installing automatic disc ripper for drive 2 (BD-RE HL-DT-ST BD-RE BP55EB40 1.03 SIK09L9HG4017)...
2021-12-19T16:17:24.638189141Z [cont-init.d] 96-install-autodiscripper-srv.sh: installing automatic disc ripper for drive 3 (DVD+R-DL HL-DT-ST DVDRAM GP60NB60 RF01 K0PL67A1949)...
2021-12-19T16:17:24.644378224Z [cont-init.d] 96-install-autodiscripper-srv.sh: installing automatic disc ripper for drive 4 (BD-RE HL-DT-ST BD-RE BP55EB40 1.03 SIK0AL9HF4519)...
2021-12-19T16:17:24.650498975Z [cont-init.d] 96-install-autodiscripper-srv.sh: installing automatic disc ripper for drive 5 (DVD+R-DL HL-DT-ST DVDRAM GP60NB60 RF01 K0TL67A2544)...
2021-12-19T16:17:24.656626808Z [cont-init.d] 96-install-autodiscripper-srv.sh: installing automatic disc ripper for drive 6 (DVD+R-DL HL-DT-ST DVDRAM GP60NB60 RF01 K01L67A2204)...
2021-12-19T16:17:24.662590892Z [cont-init.d] 96-install-autodiscripper-srv.sh: installing automatic disc ripper for drive 7 (DVD+R-DL HL-DT-ST DVDRAM GP60NB60 RF01 K0QL67A3108)...
2021-12-19T16:17:24.665624350Z [cont-init.d] 96-install-autodiscripper-srv.sh: exited 0.
2021-12-19T16:17:24.667266350Z [cont-init.d] done.
2021-12-19T16:17:24.669215601Z [services.d] starting services
2021-12-19T16:17:24.796288897Z [services.d] starting s6-fdholderd...
2021-12-19T16:17:24.800370981Z [services.d] starting autodiscripper-4...
2021-12-19T16:17:24.803707481Z [services.d] starting autodiscripper-0...
2021-12-19T16:17:24.806650356Z [services.d] starting xvfb...
2021-12-19T16:17:24.815912190Z [xvfb] starting...
2021-12-19T16:17:24.816823565Z [autodiscripper-4] starting...
2021-12-19T16:17:24.819812398Z [autodiscripper-0] starting...
2021-12-19T16:17:25.842685233Z [services.d] starting statusmonitor...
2021-12-19T16:17:25.845261316Z [statusmonitor] no file to monitor: disabling service...
2021-12-19T16:17:25.845424983Z [services.d] starting autodiscripper-5...
2021-12-19T16:17:25.847823525Z [services.d] starting autodiscripper-1...
2021-12-19T16:17:25.850515816Z [services.d] starting openbox...
2021-12-19T16:17:25.854933525Z [openbox] starting...
2021-12-19T16:17:25.859495733Z [autodiscripper-5] starting...
2021-12-19T16:17:25.861509692Z [autodiscripper-1] starting...
2021-12-19T16:17:27.871429859Z [services.d] starting certsmonitor...
2021-12-19T16:17:27.873916234Z [services.d] starting autodiscripper-7...
2021-12-19T16:17:27.876412109Z [services.d] starting autodiscripper-3...
2021-12-19T16:17:27.878975151Z [services.d] starting nginx...
2021-12-19T16:17:27.879742151Z [certsmonitor] disabling service: secure connection not enabled.
2021-12-19T16:17:27.881532609Z [services.d] starting autodiscripper-6...
2021-12-19T16:17:27.883737318Z [nginx] starting...
2021-12-19T16:17:27.884299234Z [services.d] starting autodiscripper-2...
2021-12-19T16:17:27.887469068Z [services.d] starting logmonitor...
2021-12-19T16:17:27.889696109Z [autodiscripper-7] starting...
2021-12-19T16:17:27.890445151Z [logmonitor] no file to monitor: disabling service...
2021-12-19T16:17:27.890718776Z [services.d] starting x11vnc...
2021-12-19T16:17:27.893658568Z [autodiscripper-3] starting...
2021-12-19T16:17:27.894293193Z [services.d] starting app...
2021-12-19T16:17:27.897011193Z [x11vnc] starting...
2021-12-19T16:17:27.899524193Z [autodiscripper-6] starting...
2021-12-19T16:17:27.900103860Z [app] starting MakeMKV...
2021-12-19T16:17:27.903042318Z [autodiscripper-2] starting...
2021-12-19T16:17:27.904082777Z 19/12/2021 17:17:27 passing arg to libvncserver: -rfbport
2021-12-19T16:17:27.904150818Z 19/12/2021 17:17:27 passing arg to libvncserver: 5900
2021-12-19T16:17:27.904184818Z 19/12/2021 17:17:27 passing arg to libvncserver: -rfbportv6
2021-12-19T16:17:27.904230152Z 19/12/2021 17:17:27 passing arg to libvncserver: -1
2021-12-19T16:17:27.904291860Z 19/12/2021 17:17:27 passing arg to libvncserver: -httpportv6
2021-12-19T16:17:27.904348527Z 19/12/2021 17:17:27 passing arg to libvncserver: -1
2021-12-19T16:17:27.904382485Z 19/12/2021 17:17:27 passing arg to libvncserver: -desktop
2021-12-19T16:17:27.904427860Z 19/12/2021 17:17:27 passing arg to libvncserver: MakeMKV
2021-12-19T16:17:27.905051902Z 19/12/2021 17:17:27 x11vnc version: 0.9.14 lastmod: 2015-11-14  pid: 1400
2021-12-19T16:17:27.905707985Z 19/12/2021 17:17:27 Using X display :0
2021-12-19T16:17:27.905753318Z 19/12/2021 17:17:27 rootwin: 0x43 reswin: 0x400001 dpy: 0x3a156b00
2021-12-19T16:17:27.906015652Z 19/12/2021 17:17:27 
2021-12-19T16:17:27.906632694Z 19/12/2021 17:17:27 ------------------ USEFUL INFORMATION ------------------
2021-12-19T16:17:27.910584235Z [services.d] done.
2021-12-19T16:17:27.918764402Z 19/12/2021 17:17:27 X DAMAGE available on display, using it for polling hints.
2021-12-19T16:17:27.918843736Z 19/12/2021 17:17:27   To disable this behavior use: '-noxdamage'
2021-12-19T16:17:27.918911736Z 19/12/2021 17:17:27 
2021-12-19T16:17:27.918945736Z 19/12/2021 17:17:27   Most compositing window managers like 'compiz' or 'beryl'
2021-12-19T16:17:27.918979736Z 19/12/2021 17:17:27   cause X DAMAGE to fail, and so you may not see any screen
2021-12-19T16:17:27.919013736Z 19/12/2021 17:17:27   updates via VNC.  Either disable 'compiz' (recommended) or
2021-12-19T16:17:27.919059111Z 19/12/2021 17:17:27   supply the x11vnc '-noxdamage' command line option.
2021-12-19T16:17:27.919098069Z 19/12/2021 17:17:27 X COMPOSITE available on display, using it for window polling.
2021-12-19T16:17:27.919132111Z 19/12/2021 17:17:27   To disable this behavior use: '-noxcomposite'
2021-12-19T16:17:27.919177444Z 19/12/2021 17:17:27 
2021-12-19T16:17:27.919216402Z 19/12/2021 17:17:27 Wireframing: -wireframe mode is in effect for window moves.
2021-12-19T16:17:27.919244111Z 19/12/2021 17:17:27   If this yields undesired behavior (poor response, painting
2021-12-19T16:17:27.919278069Z 19/12/2021 17:17:27   errors, etc) it may be disabled:
2021-12-19T16:17:27.919312111Z 19/12/2021 17:17:27    - use '-nowf' to disable wireframing completely.
2021-12-19T16:17:27.919357444Z 19/12/2021 17:17:27    - use '-nowcr' to disable the Copy Rectangle after the
2021-12-19T16:17:27.919391444Z 19/12/2021 17:17:27      moved window is released in the new position.
2021-12-19T16:17:27.919436777Z 19/12/2021 17:17:27   Also see the -help entry for tuning parameters.
2021-12-19T16:17:27.919482111Z 19/12/2021 17:17:27   You can press 3 Alt_L's (Left "Alt" key) in a row to 
2021-12-19T16:17:27.919516111Z 19/12/2021 17:17:27   repaint the screen, also see the -fixscreen option for
2021-12-19T16:17:27.919550111Z 19/12/2021 17:17:27   periodic repaints.
2021-12-19T16:17:27.919584111Z 19/12/2021 17:17:27 GrabServer control via XTEST.
2021-12-19T16:17:27.925275194Z 19/12/2021 17:17:27 
2021-12-19T16:17:27.925320528Z 19/12/2021 17:17:27 Scroll Detection: -scrollcopyrect mode is in effect to
2021-12-19T16:17:27.925354528Z 19/12/2021 17:17:27   use RECORD extension to try to detect scrolling windows
2021-12-19T16:17:27.925388528Z 19/12/2021 17:17:27   (induced by either user keystroke or mouse input).
2021-12-19T16:17:27.925437528Z 19/12/2021 17:17:27   If this yields undesired behavior (poor response, painting
2021-12-19T16:17:27.925473194Z 19/12/2021 17:17:27   errors, etc) it may be disabled via: '-noscr'
2021-12-19T16:17:27.925507194Z 19/12/2021 17:17:27   Also see the -help entry for tuning parameters.
2021-12-19T16:17:27.925543194Z 19/12/2021 17:17:27   You can press 3 Alt_L's (Left "Alt" key) in a row to 
2021-12-19T16:17:27.925588528Z 19/12/2021 17:17:27   repaint the screen, also see the -fixscreen option for
2021-12-19T16:17:27.925622528Z 19/12/2021 17:17:27   periodic repaints.
2021-12-19T16:17:27.927018944Z 19/12/2021 17:17:27 
2021-12-19T16:17:27.927075611Z 19/12/2021 17:17:27 XKEYBOARD: number of keysyms per keycode 7 is greater
2021-12-19T16:17:27.927132278Z 19/12/2021 17:17:27   than 4 and 51 keysyms are mapped above 4.
2021-12-19T16:17:27.927171278Z 19/12/2021 17:17:27   Automatically switching to -xkb mode.
2021-12-19T16:17:27.927205278Z 19/12/2021 17:17:27   If this makes the key mapping worse you can
2021-12-19T16:17:27.927239278Z 19/12/2021 17:17:27   disable it with the "-noxkb" option.
2021-12-19T16:17:27.927284611Z 19/12/2021 17:17:27   Also, remember "-remap DEAD" for accenting characters.
2021-12-19T16:17:27.927318611Z 19/12/2021 17:17:27 
2021-12-19T16:17:27.927375278Z 19/12/2021 17:17:27 X FBPM extension not supported.
2021-12-19T16:17:27.927409278Z Xlib:  extension "DPMS" missing on display ":0".
2021-12-19T16:17:27.927458278Z 19/12/2021 17:17:27 X display is not capable of DPMS.
2021-12-19T16:17:27.927492278Z 19/12/2021 17:17:27 --------------------------------------------------------
2021-12-19T16:17:27.927526278Z 19/12/2021 17:17:27 
2021-12-19T16:17:27.927732569Z 19/12/2021 17:17:27 Default visual ID: 0x21
2021-12-19T16:17:27.931298153Z 19/12/2021 17:17:27 Read initial data from X display into framebuffer.
2021-12-19T16:17:27.931439153Z 19/12/2021 17:17:27 initialize_screen: fb_depth/fb_bpp/fb_Bpl 24/32/5120
2021-12-19T16:17:27.931484445Z 19/12/2021 17:17:27 
2021-12-19T16:17:27.931518486Z 19/12/2021 17:17:27 X display :0 is 32bpp depth=24 true color
2021-12-19T16:17:27.932662111Z 19/12/2021 17:17:27 
2021-12-19T16:17:27.932735153Z 19/12/2021 17:17:27 Listening for VNC connections on TCP port 5900
2021-12-19T16:17:27.933044195Z 19/12/2021 17:17:27 
2021-12-19T16:17:27.933089528Z 19/12/2021 17:17:27 Xinerama is present and active (e.g. multi-head).
2021-12-19T16:17:27.933293528Z 19/12/2021 17:17:27 Xinerama: number of sub-screens: 1
2021-12-19T16:17:27.933338903Z 19/12/2021 17:17:27 Xinerama: no blackouts needed (only one sub-screen)
2021-12-19T16:17:27.933372861Z 19/12/2021 17:17:27 
2021-12-19T16:17:27.937592070Z 19/12/2021 17:17:27 fb read rate: 1033 MB/sec
2021-12-19T16:17:27.937660070Z 19/12/2021 17:17:27 fast read: reset -wait  ms to: 10
2021-12-19T16:17:27.937716695Z 19/12/2021 17:17:27 fast read: reset -defer ms to: 10
2021-12-19T16:17:27.938721028Z 19/12/2021 17:17:27 The X server says there are 10 mouse buttons.
2021-12-19T16:17:27.938913653Z 19/12/2021 17:17:27 screen setup finished.
2021-12-19T16:17:27.938947653Z 19/12/2021 17:17:27 
2021-12-19T16:17:27.939026987Z 
2021-12-19T16:17:27.939060987Z The VNC desktop is:      makemkv-serien-ix-chart-5c856cfbb5-wxfwc:0
2021-12-19T16:17:27.939094987Z PORT=5900
2021-12-19T16:17:27.939122612Z 
2021-12-19T16:17:27.939156612Z ******************************************************************************
2021-12-19T16:17:27.939201987Z Have you tried the x11vnc '-ncache' VNC client-side pixel caching feature yet?
2021-12-19T16:17:27.939238278Z 
2021-12-19T16:17:27.939272278Z The scheme stores pixel data offscreen on the VNC viewer side for faster
2021-12-19T16:17:27.939306278Z retrieval.  It should work with any VNC viewer.  Try it by running:
2021-12-19T16:17:27.939351612Z 
2021-12-19T16:17:27.939385612Z     x11vnc -ncache 10 ...
2021-12-19T16:17:27.939419612Z 
2021-12-19T16:17:27.939453612Z One can also add -ncache_cr for smooth 'copyrect' window motion.
2021-12-19T16:17:27.939487612Z More info: http://www.karlrunge.com/x11vnc/faq.html#faq-client-caching
2021-12-19T16:17:27.939532945Z 
2021-12-19T16:18:17.025503695Z 19/12/2021 17:18:17 Got connection from client 127.0.0.1
2021-12-19T16:18:17.025576695Z 19/12/2021 17:18:17   other clients:
2021-12-19T16:18:17.025627029Z 19/12/2021 17:18:17 Got 'ws' WebSockets handshake
2021-12-19T16:18:17.029371571Z 19/12/2021 17:18:17 Got protocol: binary
2021-12-19T16:18:17.041661863Z 19/12/2021 17:18:17   - webSocketsHandshake: using binary/raw encoding
2021-12-19T16:18:17.041718529Z 19/12/2021 17:18:17   - WebSockets client version hybi-13
2021-12-19T16:18:17.042136571Z 19/12/2021 17:18:17 Disabled X server key autorepeat.
2021-12-19T16:18:17.042209571Z 19/12/2021 17:18:17   to force back on run: 'xset r on' (3 times)
2021-12-19T16:18:17.042266238Z 19/12/2021 17:18:17 incr accepted_client=1 for 127.0.0.1:37576  sock=10
2021-12-19T16:18:17.046137488Z 19/12/2021 17:18:17 Client Protocol Version 3.8
2021-12-19T16:18:17.046194155Z 19/12/2021 17:18:17 Protocol version sent 3.8, using 3.8
2021-12-19T16:18:17.050945196Z 19/12/2021 17:18:17 rfbProcessClientSecurityType: executing handler for type 1
2021-12-19T16:18:17.051001863Z 19/12/2021 17:18:17 rfbProcessClientSecurityType: returning securityResult for client rfb version >= 3.8
2021-12-19T16:18:17.061093447Z 19/12/2021 17:18:17 Pixel format for client 127.0.0.1:
2021-12-19T16:18:17.061150114Z 19/12/2021 17:18:17   32 bpp, depth 24, little endian
2021-12-19T16:18:17.061189114Z 19/12/2021 17:18:17   true colour: max r 255 g 255 b 255, shift r 16 g 8 b 0
2021-12-19T16:18:17.061297114Z 19/12/2021 17:18:17 no translation needed
2021-12-19T16:18:17.061337822Z 19/12/2021 17:18:17 Enabling NewFBSize protocol extension for client 127.0.0.1
2021-12-19T16:18:17.061371822Z 19/12/2021 17:18:17 Enabling full-color cursor updates for client 127.0.0.1
2021-12-19T16:18:17.061410780Z 19/12/2021 17:18:17 Using image quality level 6 for client 127.0.0.1
2021-12-19T16:18:17.061444822Z 19/12/2021 17:18:17 Using JPEG subsampling 0, Q79 for client 127.0.0.1
2021-12-19T16:18:17.061552155Z 19/12/2021 17:18:17 Using compression level 9 for client 127.0.0.1
2021-12-19T16:18:17.061591114Z 19/12/2021 17:18:17 Enabling LastRect protocol extension for client 127.0.0.1
2021-12-19T16:18:17.061636447Z 19/12/2021 17:18:17 rfbProcessClientNormalMessage: ignoring unsupported encoding type Enc(0xFFFFFECC)
2021-12-19T16:18:17.061664114Z 19/12/2021 17:18:17 Using tight encoding for client 127.0.0.1
2021-12-19T16:18:17.561804551Z 19/12/2021 17:18:17 client_set_net: 127.0.0.1  0.0000
2021-12-19T16:18:17.567330676Z 19/12/2021 17:18:17 created   xdamage object: 0x40002c
2021-12-19T16:18:27.011880319Z 19/12/2021 17:18:27 created selwin: 0x40002d
2021-12-19T16:18:27.017129569Z 19/12/2021 17:18:27 called initialize_xfixes()
2021-12-19T16:18:45.567495341Z 19/12/2021 17:18:45 copy_tiles: allocating first_line at size 41
2021-12-19T16:18:47.440811377Z 19/12/2021 17:18:47 client 1 network rate 1376.8 KB/sec (21643.6 eff KB/sec)
2021-12-19T16:18:47.440998711Z 19/12/2021 17:18:47 client 1 latency:  4.4 ms
2021-12-19T16:18:47.441112086Z 19/12/2021 17:18:47 dt1: 0.0027, dt2: 0.0061 dt3: 0.0044 bytes: 12091
2021-12-19T16:18:47.441489461Z 19/12/2021 17:18:47 link_rate: LR_LAN - 4 ms, 1376 KB/s
2021-12-19T16:18:52.726028056Z info string reallocated, size=556
2021-12-19T16:18:52.726373431Z info string reallocated, size=555
2021-12-19T16:18:52.727044597Z info string reallocated, size=555

leuchtrakete666 avatar Dec 19 '21 15:12 leuchtrakete666

another thing i encountered is the last disk behaving strange. i rip 8 disks, all get finished and the last is always taking hours, sometimes up to 12 hours! no matter what drive its in, bluray or dvd. but when i put after lets say 8 hours again other disks in the other drives this one slow disk start to rip at faster speed also.

leuchtrakete666 avatar Dec 23 '21 09:12 leuchtrakete666

I assume that you also get the slow speed if you rip only 1 disc ?

jlesage avatar Dec 23 '21 15:12 jlesage

right now i run 8 drives simultaneously. 3 bluray (Hitachi LG BP55EB40 - libredrive enabled) and 5 dvd (Hitachi LG GP60NB60).

when i rip in single drive mode (autoripper set to 0) directly from the webgui, it rips in normal speed. the drives behave all the same wether its the bluray or the dvd drives.

when i rip a single disk with autoripper set to 1 it takes extreme long. i just tried again. with autripper set to 0 it takes about 20 min for the dvd. with autoripper set to 1 the same dvd in the same drive is after 20 min at about 18 - 20 %.

leuchtrakete666 avatar Dec 23 '21 16:12 leuchtrakete666

Sounds like a bandwidth issue to me, hdd/ssd maxed out, IO maxed out, CPU maxed out, Memory maxed out

David Smythe Sent from my  iPhone 12 Pro Max on iOS 15

On Dec 23, 2021, at 11:47 AM, leuchtrakete666 @.***> wrote:



right now i run 8 drives simultaneously. 3 bluray (Hitachi LG BP55EB40 - libredrive enabled) and 5 dvd (Hitachi LG GP60NB60).

when i rip in single drive mode (autoripper set to 0) directly from the webgui, it rips in normal speed. the drives behave all the same wether its the bluray or the dvd drives.

when i rip a single disk with autoripper set to 1 it takes extreme long. i just tried again. with autripper set to 0 it takes about 20 min for the dvd. with autoripper set to 1 the same dvd in the same drive is after 20 min at about 18 - 20 %.

— Reply to this email directly, view it on GitHubhttps://github.com/jlesage/docker-makemkv/issues/127#issuecomment-1000419663, or unsubscribehttps://github.com/notifications/unsubscribe-auth/AA5UEAKUAFJ2ITOJNZX5OVDUSNHDPANCNFSM5KMAQTOQ. You are receiving this because you are subscribed to this thread.Message ID: @.***>

C4Wiz avatar Dec 23 '21 16:12 C4Wiz

cpu and memory is good. cpu with 8 dvd simultaneously is at 50% load, memory is more than enough with 48G. hard drives i also dont think is the problem. the read speed is max about 6,6 MB/s with 8 drives running on max speed (if they would ...) is 52,8 MB/s to write on the hard drives (ZFS). should be ok.

maybe the IO? the drives are all usb 2, connected to a usb3 powered hub. if i just do maths, this should be ok also??

the strange thing is, also with only 1 disk the autoripper is slow and the rip from the gui runs at normal speed.

and its not just the saving to mkv, its also the preperation that is very slow, like title processing and decrypting.

leuchtrakete666 avatar Dec 23 '21 17:12 leuchtrakete666

Usb2 max is 480Mbit, 60 Mb/s. If each drive by itself can reach max speed then it is a saturation issue

David Smythe Sent from my  iPhone 12 Pro Max on iOS 15

On Dec 23, 2021, at 12:08 PM, leuchtrakete666 @.***> wrote:



cpu and memory is good. cpu with 8 dvd simultaneously is at 50% load, memory is more than enough with 48G. hard drives i also dont think is the problem. the read speed is max about 6,6 MB/s with 8 drives running on max speed (if they would ...) is 52,8 MB/s to write on the hard drives (ZFS). should be ok.

maybe the IO? the drives are all usb 2, connected to a usb3 powered hub. if i just do maths, this should be ok also??

— Reply to this email directly, view it on GitHubhttps://github.com/jlesage/docker-makemkv/issues/127#issuecomment-1000429750, or unsubscribehttps://github.com/notifications/unsubscribe-auth/AA5UEALDYOAYMEQWQFHQ5WLUSNJQVANCNFSM5KMAQTOQ. You are receiving this because you commented.Message ID: @.***>

C4Wiz avatar Dec 23 '21 17:12 C4Wiz

I also assume that while the automatic disc ripper runs, the UI is not also ripping the disc at the same time ?

jlesage avatar Dec 23 '21 17:12 jlesage

Usb2 max is 480Mbit, 60 Mb/s. If each drive by itself can reach max speed then it is a saturation issue David Smythe Sent from my  iPhone 12 Pro Max on iOS 15 On Dec 23, 2021, at 12:08 PM, leuchtrakete666 @.> wrote:  cpu and memory is good. cpu with 8 dvd simultaneously is at 50% load, memory is more than enough with 48G. hard drives i also dont think is the problem. the read speed is max about 6,6 MB/s with 8 drives running on max speed (if they would ...) is 52,8 MB/s to write on the hard drives (ZFS). should be ok. maybe the IO? the drives are all usb 2, connected to a usb3 powered hub. if i just do maths, this should be ok also?? — Reply to this email directly, view it on GitHub<#127 (comment)>, or unsubscribehttps://github.com/notifications/unsubscribe-auth/AA5UEALDYOAYMEQWQFHQ5WLUSNJQVANCNFSM5KMAQTOQ. You are receiving this because you commented.Message ID: @.>

like i said, every drive has a max of 6,6 M/s far away from 60 M/s. and again, this happen also when i only rip 1 disk with autoripper set to 1.

leuchtrakete666 avatar Dec 23 '21 17:12 leuchtrakete666

I also assume that while the automatic disc ripper runs, the UI is not also ripping the disc at the same time ?

i dont think so. the UI is just showing the typical scsi errors, and the drive symbol is showing if a disk get loaded. but nothing else.

i guess in the target directory, if there is a parallel rip from the ui and the autoripper, i would end up with 2 datasets, what is not the case.

leuchtrakete666 avatar Dec 23 '21 17:12 leuchtrakete666

While the automatic disc ripper runs (with 1 disc), can you provide the output of:

docker exec <container name> ps

jlesage avatar Dec 23 '21 17:12 jlesage

loading disc:

PID   USER     TIME  COMMAND
    1 root      0:00 s6-svscan -s -t0 /var/run/s6/services
   32 root      0:00 s6-supervise s6-fdholderd
  835 root      0:00 s6-supervise autodiscripper-3
  836 root      0:00 s6-supervise autodiscripper-4
  839 root      0:00 s6-supervise autodiscripper-0
  841 root      0:00 s6-supervise openbox
  842 root      0:00 s6-supervise autodiscripper-7
  843 root      0:00 s6-supervise app
  844 root      0:00 s6-supervise autodiscripper-5
  845 root      0:00 s6-supervise nginx
  847 root      0:00 s6-supervise x11vnc
  848 root      0:00 s6-supervise autodiscripper-2
  849 root      0:00 s6-supervise autodiscripper-6
  850 root      0:00 s6-supervise xvfb
  852 root      0:00 s6-supervise autodiscripper-1
 1052 daemon    0:00 s6-fdholderd -1 -i rules
 1058 app       0:00 sh ./autodiscripper-2
 1067 app       0:00 sh ./autodiscripper-6
 1092 app       0:00 sh ./autodiscripper-3
 1106 app       0:00 sh ./autodiscripper-7
 1124 root      0:04 /usr/bin/Xvfb :0 -screen 0 1920x1080x24
 1235 root      0:00 s6-supervise certsmonitor
 1244 root      0:00 nginx: master process /usr/sbin/nginx -c /etc/nginx/nginx.
 1267 app       0:00 sh ./autodiscripper-1
 1283 app       0:00 sh ./autodiscripper-5
 1295 root      0:06 /usr/bin/x11vnc -display :0 -rfbport 5900 -rfbportv6 -1 -n
 1308 app       0:00 sh ./autodiscripper-0
 1321 app       0:00 sh ./autodiscripper-4
 1359 app       0:00 /usr/bin/openbox
 1382 nginx     0:00 nginx: worker process
 1384 nginx     0:00 nginx: worker process
 1556 root      0:00 s6-supervise statusmonitor
 1557 root      0:00 s6-supervise logmonitor
 1674 app       0:02 {makemkv} /opt/makemkv/bin makemkv
 1697 app       0:00 /opt/makemkv/bin/makemkvcon guiserver A0001+shm
 1718 app       0:00 /opt/makemkv/bin/makemkvcon -r --cache=1 info disc:9999
 1719 app       0:00 grep ^DRV:6,
 1727 app       0:00 /opt/makemkv/bin/makemkvcon -r --cache=1 info disc:9999
 1728 app       0:00 grep ^DRV:7,
 1744 app       0:00 /opt/makemkv/bin/makemkvcon -r --cache=1 info disc:9999
 1745 app       0:00 grep ^DRV:2,
 1746 app       0:00 /opt/makemkv/bin/makemkvcon -r --cache=1 info disc:9999
 1747 app       0:00 grep ^DRV:3,
 1762 app       0:00 /opt/makemkv/bin/makemkvcon -r --cache=1 info disc:9999
 1763 app       0:00 grep ^DRV:4,
 1776 app       0:00 /opt/makemkv/bin/makemkvcon -r --cache=1 info disc:9999
 1777 app       0:00 grep ^DRV:1,
 1781 app       0:00 /opt/makemkv/bin/makemkvcon -r --cache=1 info disc:9999
 1782 app       0:00 grep ^DRV:0,
 1793 app       0:00 /opt/makemkv/bin/makemkvcon -r --cache=1 info disc:9999
 1794 app       0:00 grep ^DRV:5,
 1800 root      0:00 ps

leuchtrakete666 avatar Dec 23 '21 17:12 leuchtrakete666

processing titles:

PID   USER     TIME  COMMAND
    1 root      0:00 s6-svscan -s -t0 /var/run/s6/services
   32 root      0:00 s6-supervise s6-fdholderd
  835 root      0:00 s6-supervise autodiscripper-3
  836 root      0:00 s6-supervise autodiscripper-4
  839 root      0:00 s6-supervise autodiscripper-0
  841 root      0:00 s6-supervise openbox
  842 root      0:00 s6-supervise autodiscripper-7
  843 root      0:00 s6-supervise app
  844 root      0:00 s6-supervise autodiscripper-5
  845 root      0:00 s6-supervise nginx
  847 root      0:00 s6-supervise x11vnc
  848 root      0:00 s6-supervise autodiscripper-2
  849 root      0:00 s6-supervise autodiscripper-6
  850 root      0:00 s6-supervise xvfb
  852 root      0:00 s6-supervise autodiscripper-1
 1052 daemon    0:00 s6-fdholderd -1 -i rules
 1058 app       0:00 sh ./autodiscripper-2
 1067 app       0:00 sh ./autodiscripper-6
 1092 app       0:00 sh ./autodiscripper-3
 1106 app       0:00 sh ./autodiscripper-7
 1124 root      0:05 /usr/bin/Xvfb :0 -screen 0 1920x1080x24
 1235 root      0:00 s6-supervise certsmonitor
 1244 root      0:00 nginx: master process /usr/sbin/nginx -c /etc/nginx/nginx.
 1267 app       0:00 sh ./autodiscripper-1
 1283 app       0:00 sh ./autodiscripper-5
 1295 root      0:08 /usr/bin/x11vnc -display :0 -rfbport 5900 -rfbportv6 -1 -n
 1308 app       0:00 sh ./autodiscripper-0
 1321 app       0:00 sh ./autodiscripper-4
 1359 app       0:00 /usr/bin/openbox
 1382 nginx     0:01 nginx: worker process
 1384 nginx     0:00 nginx: worker process
 1556 root      0:00 s6-supervise statusmonitor
 1557 root      0:00 s6-supervise logmonitor
 1674 app       0:02 {makemkv} /opt/makemkv/bin makemkv
 1697 app       0:00 /opt/makemkv/bin/makemkvcon guiserver A0001+shm
 1874 app       0:00 tail -f /tmp/tmp.cjkobb
 1875 app       0:00 yad --fixed --width=384 --title Automatic Disc Ripper --wi
 1876 app       0:04 /opt/makemkv/bin/makemkvcon -r --progress=-same --minlengt
 1877 app       0:00 sh ./autodiscripper-1
 3087 app       0:00 /opt/makemkv/bin/makemkvcon -r --cache=1 info disc:9999
 3088 app       0:00 grep ^DRV:2,
 3097 app       0:00 /opt/makemkv/bin/makemkvcon -r --cache=1 info disc:9999
 3098 app       0:00 grep ^DRV:0,
 3108 app       0:00 /opt/makemkv/bin/makemkvcon -r --cache=1 info disc:9999
 3109 app       0:00 grep ^DRV:5,
 3118 app       0:00 /opt/makemkv/bin/makemkvcon -r --cache=1 info disc:9999
 3119 app       0:00 grep ^DRV:4,
 3129 app       0:00 /opt/makemkv/bin/makemkvcon -r --cache=1 info disc:9999
 3130 app       0:00 grep ^DRV:6,
 3139 app       0:00 /opt/makemkv/bin/makemkvcon -r --cache=1 info disc:9999
 3140 app       0:00 grep ^DRV:7,
 3148 app       0:00 /opt/makemkv/bin/makemkvcon -r --cache=1 info disc:9999
 3149 app       0:00 grep ^DRV:3,
 3161 root      0:00 ps

leuchtrakete666 avatar Dec 23 '21 17:12 leuchtrakete666

Can you try to set AUTO_DISC_RIPPER_PARALLEL_RIP to 0 to see if it makes any difference ?

Also, could you share other settings of the containers ? Maybe provide the docker run command you used to create the container ?

jlesage avatar Dec 23 '21 17:12 jlesage

with the parallel rip set to 0 it works.

i run the docker on truenas scale. but it makes no difference. i also tried it native on my linux laptop with 64G ram and a 8/16 cpu and there i have the same issues with the docker.

if i run it with the makemkv app and fire up multiple instances it also works without problems.

these are my settings:

MAKEMKV_KEY = xxxxxxx AUTO_DISC_RIPPER_MIN_TITLE_LENGTH = 2500 AUTO_DISC_RIPPER_PARALLEL_RIP = 1 AUTO_DISC_RIPPER_EJECT = 1 AUTO_DISC_RIPPER = 1 TZ = Europe/Vienna DISPLAY_WIDTH = 1920 DISPLAY_HEIGHT = 1080 AUTO_DISC_RIPPER_INTERVAL = 20

with AUTO_DISC_RIPPER_PARALLEL_RIP 0it rips normal. this is working.

leuchtrakete666 avatar Dec 23 '21 17:12 leuchtrakete666

and here is the ps:

    1 root      0:00 s6-svscan -s -t0 /var/run/s6/services
   33 root      0:00 s6-supervise s6-fdholderd
  702 root      0:00 s6-supervise autodiscripper
  704 root      0:00 s6-supervise nginx
  709 root      0:00 s6-supervise openbox
  710 root      0:00 s6-supervise xvfb
  711 root      0:00 s6-supervise x11vnc
  712 root      0:00 s6-supervise app
  893 daemon    0:00 s6-fdholderd -1 -i rules
  910 app       0:00 sh ./autodiscripper
  922 root      0:00 nginx: master process /usr/sbin/nginx -c /etc/nginx/nginx.
  934 root      0:08 /usr/bin/Xvfb :0 -screen 0 1920x1080x24
  973 nginx     0:00 nginx: worker process
  974 nginx     0:00 nginx: worker process
  997 root      0:10 /usr/bin/x11vnc -display :0 -rfbport 5900 -rfbportv6 -1 -n
 1005 app       0:00 /usr/bin/openbox
 1338 app       0:02 {makemkv} /opt/makemkv/bin makemkv
 1362 app       0:03 /opt/makemkv/bin/makemkvcon guiserver A0001+shm
 1438 app       0:00 tail -f /tmp/tmp.JJMCee
 1439 app       0:05 yad --fixed --width=384 --title Automatic Disc Ripper --wi
 1440 app       0:49 /opt/makemkv/bin/makemkvcon -r --progress=-same --minlengt
 1441 app       0:14 sh ./autodiscripper
103168 root      0:00 ps

leuchtrakete666 avatar Dec 23 '21 17:12 leuchtrakete666

yep, same on my laptop. i just double check, with the same drive and dvd, like in my nas.

when i set the parallel rip to 0 it also works on my laptop.

the same behavior for the dvd drives as well as the libredrive enabled bd drives.

leuchtrakete666 avatar Dec 23 '21 18:12 leuchtrakete666

this is my docker run on my laptop:

docker run -d \
    --name=makemkv \
    -p 5800:5800 \
    -v $HOME/docker/appdata/makemkv:/config:rw \
    -v $HOME:/storage:ro \
    -v /mnt/TrueNAS/Media/ripping:/output:rw \
    -e AUTO_DISC_RIPPER=1 \
    -e AUTO_DISC_RIPPER_EJECT=1 \
    -e AUTO_DISC_RIPPER_PARALLEL_RIP=1 \
    -e AUTO_DISC_RIPPER_MIN_TITLE_LENGTH=2500 \
    -e MAKEMKV_KEY=xxxxxxxxxxxxxxxxxxxxxxxxxxxxxxxxxxxx \
    --device /dev/sr0 \
    --device /dev/sr1 \
    --device /dev/sr2 \
    --device /dev/sr3 \
    --device /dev/sr4 \
    --device /dev/sr5 \
    --device /dev/sr6 \
    --device /dev/sr7 \
    --device /dev/sg1 \
    --device /dev/sg2 \
    --device /dev/sg3 \
    --device /dev/sg4 \
    --device /dev/sg5 \
    --device /dev/sg6 \
    --device /dev/sg7 \
    --device /dev/sg8 \
    jlesage/makemkv

leuchtrakete666 avatar Dec 23 '21 18:12 leuchtrakete666

the drives are mapped correctly.

by the way, i simply do ls -la /dev | grep rom to determine the optical drives.

leuchtrakete666 avatar Dec 23 '21 18:12 leuchtrakete666

Ok, I think the problem is with the way the presence of a disc is checked. The MakeMKV CLI is used for this and this seems to affect ripping in progress.

With AUTO_DISC_RIPPER_PARALLEL_RIP=1, can you try to increase the value of AUTO_DISC_RIPPER_INTERVAL to 60 or 120 seconds ?

jlesage avatar Dec 23 '21 21:12 jlesage

it seems to help a little. i use now 60 seconds. the ripping is still not at full speed and the preparing process - titles, decrypting, ... still takes long. what is also strange, when puting a new disk, while the others are still ripping, it takes up to 10 min or so until the disk recognized by the autoripper. its loaded, i can see the disk info on the right side but it takes ages until the process start.

cant it be implemented, that the disc is only checked once, when the tray is closed? to prevent the continuous checking process?

leuchtrakete666 avatar Dec 23 '21 22:12 leuchtrakete666

ok, thanks for your help for now. please dont investigate further, i will try other drives and report back.

in some days i will know more.

enjoy christmas.

leuchtrakete666 avatar Dec 24 '21 00:12 leuchtrakete666

most of the problems where caused by the drives i used. i tried with different ones and now it works. i increased the AUTO_DISC_RIPPER_INTERVAL to 150. this solved all problems.

the only thing that still is strange, is the last disc problem. i ripped, lets say 40 discs, all discs are finally finished and ejected. the last disc that remain than slows down and takes forever to finish.

leuchtrakete666 avatar Dec 25 '21 17:12 leuchtrakete666

So I'm still seeing this issue. I am also thinking its related to the polling for new disks as every few seconds the dvd makes a weird noise when I have the auto-ripper on vs not on, so reading these replies I'll try to reduce the time to rip, at 5 seconds it seems its interupting it pretty bad and the disc normally takes 45 minutes has been running all day.

lancer1977 avatar Jan 15 '23 05:01 lancer1977

Had the same problem. A normal bluray wasn't even at 20% after more than an hour. Changed it to 150, and it's going way faster now. The same progress only took me 8 minutes afterward.

KonradStuewe avatar Jan 19 '23 21:01 KonradStuewe

I think this issue can be closed. I added a note about this in the documentation.

jlesage avatar Feb 13 '23 02:02 jlesage