Traceback (most recent call last):
  File "/app/client.py", line 465, in _start
    task.run(item, itemType, author, ident, full, queuedFor, ctx)
  File "/app/client.py", line 220, in run
    self._run(*args, **kwargs)
  File "/app/client.py", line 212, in _run
    self._run_vod(item)
  File "/app/client.py", line 104, in _run_vod
    open_and_wait([
  File "/app/client.py", line 35, in open_and_wait
    process = subprocess_with_logging.run_with_log(args, shell=False, preexec_fn=os.setpgrp, check=True)
  File "/app/subprocess_with_logging.py", line 105, in run_with_log
    raise subprocess.CalledProcessError(returncode = p.returncode, cmd = args)
subprocess.CalledProcessError: Command '['yt-dlp', '--ignore-config', '--skip-download', '--trim-filenames', '200', '--ignore-no-formats-error', '--write-info-json', '--write-description', '--write-thumbnail', '--write-all-thumbnails', '--no-check-certificate', '--retries', '4', '--limit-rate', '300k', '-o', 'infojson:%(id)s', '--proxy', 'http://localhost:4553', 'https://twitch.tv/videos/1883012172']' returned non-zero exit status 1.

/data/v18830121721697912536.3964522.tmp
Logs:
[2023-10-21 18:22:16,402] INFO PRINT <__main__.Logger object at 0x7f3783fa1610> (417/write/client.py)
[2023-10-21 18:22:16,402] INFO PRINT <_io.TextIOWrapper name='<stdout>' mode='w' encoding='utf-8'> (417/write/client.py)
[2023-10-21 18:22:16,402] INFO PRINT Finished RedirectStdout for item v:1883012172 (417/write/client.py)
[2023-10-21 18:22:16,402] INFO PRINT Starting DownloadData for item v1883012172 (417/write/client.py)
[2023-10-21 18:22:16,402] INFO PRINT Starting warcprox for Item 1883012172 (417/write/client.py)
[2023-10-21 18:22:20,413] DEBUG Starting new HTTP connection (1): localhost:4553 (245/_new_conn/connectionpool.py)
[2023-10-21 18:22:20,416] DEBUG http://localhost:4553 "WARCPROX_WRITE_RECORD /burnthetwitch_client_version HTTP/1.1" 204 0 (547/_make_request/connectionpool.py)
[2023-10-21 18:22:20,416] INFO PRINT Downloading metadata (417/write/client.py)
[2023-10-21 18:22:20,416] INFO Running subprocess: ['yt-dlp', '--ignore-config', '--skip-download', '--trim-filenames', '200', '--ignore-no-formats-error', '--write-info-json', '--write-description', '--write-thumbnail', '--write-all-thumbnails', '--no-check-certificate', '--retries', '4', '--limit-rate', '300k', '-o', 'infojson:%(id)s', '--proxy', 'http://localhost:4553', 'https://twitch.tv/videos/1883012172'] (31/run_with_log/subprocess_with_logging.py)
[2023-10-21 18:22:21,162] INFO STDOUT [twitch:vod] Extracting URL: https://twitch.tv/videos/1883012172 (94/run_with_log/subprocess_with_logging.py)
[2023-10-21 18:22:21,163] INFO STDOUT [twitch:vod] 1883012172: Downloading stream metadata GraphQL (94/run_with_log/subprocess_with_logging.py)
[2023-10-21 18:22:21,455] INFO STDERR ERROR: [twitch:vod] 1883012172: Video 1883012172 does not exist (85/run_with_log/subprocess_with_logging.py)
[2023-10-21 18:22:21,487] INFO Process exited with status 1 (103/run_with_log/subprocess_with_logging.py)
[2023-10-21 18:22:21,487] INFO PRINT Terminating warcprox (417/write/client.py)
[2023-10-21 18:22:23,544] INFO PRINT Caught exception! (417/write/client.py)
[2023-10-21 18:22:23,545] INFO PRINT Sending to server and aborting. (417/write/client.py)


Warcprox log:
2023-10-21 18:22:16,612 47 INFO MainThread warcprox.warcproxy.WarcProxy.__init__(mitmproxy.py:617) 100 proxy threads
2023-10-21 18:22:16,660 47 NOTICE MainThread warcprox.warcproxy.WarcProxy.server_activate(warcproxy.py:493) listening on 127.0.0.1:4553
2023-10-21 18:22:16,661 47 INFO MainThread warcprox.dedup.DedupDb.start(dedup.py:98) creating new deduplication database ./warcprox.sqlite
2023-10-21 18:22:16,664 47 INFO DedupLoader(tid=49) warcprox.BasePostfetchProcessor._run(__init__.py:134) <DedupLoader(DedupLoader(tid=49), started 139806596499200)> starting up
2023-10-21 18:22:16,664 47 INFO WarcWriterProcessor(tid=50) warcprox.writerthread.WarcWriterProcessor._run(__init__.py:134) <WarcWriterProcessor(WarcWriterProcessor(tid=50), started 139806588106496)> starting up
2023-10-21 18:22:16,675 47 INFO DedupDb(tid=51) warcprox.BasePostfetchProcessor._run(__init__.py:134) <ListenerPostfetchProcessor(DedupDb(tid=51), started 139806579545856)> starting up
2023-10-21 18:22:16,675 47 INFO StatsProcessor(tid=52) warcprox.stats.StatsProcessor._run(__init__.py:134) <StatsProcessor(StatsProcessor(tid=52), started 139806570891008)> starting up
2023-10-21 18:22:16,676 47 INFO StatsProcessor(tid=52) warcprox.stats.StatsProcessor._startup(stats.py:108) opening existing stats database ./warcprox.sqlite
2023-10-21 18:22:16,676 47 INFO CrawlLogger(tid=53) warcprox.BasePostfetchProcessor._run(__init__.py:134) <ListenerPostfetchProcessor(CrawlLogger(tid=53), started 139806218647296)> starting up
2023-10-21 18:22:16,676 47 INFO RunningStats(tid=54) warcprox.BasePostfetchProcessor._run(__init__.py:134) <ListenerPostfetchProcessor(RunningStats(tid=54), started 139806210254592)> starting up
2023-10-21 18:22:16,690 47 INFO StatsProcessor(tid=52) warcprox.stats.StatsProcessor._startup(stats.py:125) created table buckets_of_stats in ./warcprox.sqlite
2023-10-21 18:22:20,415 47 INFO WarcWriterProcessor(tid=50) warcprox.writer.WarcWriter.open(writer.py:93) warc destination directory ./warcs doesn't exist, creating it
/usr/local/lib/python3.9/site-packages/hanzo/warctools/record.py:174: FutureWarning: GzipFile was opened for writing, but this will change in future Python releases.  Specify the mode argument for opening it for writing.
  out = GzipFile(fileobj=out)
2023-10-21 18:22:20,417 47 INFO WarcWriterProcessor(tid=50) warcprox.writerthread.WarcWriterProcessor._log(writerthread.py:133) 127.0.0.1 204 WARCPROX_WRITE_RECORD /burnthetwitch_client_version text=plain size=95 sha1:d021c28ded5cc0306d8bb0e3209ae690757c319e resource WARCPROX-20231021182220416-00000-nbctw1dq.warc.gz offset=336
2023-10-21 18:22:20,917 47 INFO StatsProcessor(tid=52) warcprox.stats.StatsProcessor._get_process_put(__init__.py:207) gathered batch of 1 in 2.23 sec
2023-10-21 18:22:21,452 47 INFO WarcWriterProcessor(tid=50) warcprox.writerthread.WarcWriterProcessor._log(writerthread.py:133) 127.0.0.1 200 POST https://gql.twitch.tv/gql application/json size=350 sha1:d44c9baf8081ad657149831c0fc85ab5852e8254 response WARCPROX-20231021182220416-00000-nbctw1dq.warc.gz offset=715
2023-10-21 18:22:22,166 47 NOTICE MainThread warcprox.warcproxy.WarcProxy.server_close(warcproxy.py:501) shutting down
2023-10-21 18:22:22,452 47 INFO DedupLoader(tid=49) warcprox.BasePostfetchProcessor._run(__init__.py:144) <DedupLoader(DedupLoader(tid=49), started 139806596499200)> shutting down
2023-10-21 18:22:22,453 47 INFO WarcWriterProcessor(tid=50) warcprox.writerthread.WarcWriterProcessor._run(__init__.py:144) <WarcWriterProcessor(WarcWriterProcessor(tid=50), started 139806588106496)> shutting down
2023-10-21 18:22:22,466 47 INFO DedupDb(tid=51) warcprox.BasePostfetchProcessor._run(__init__.py:144) <ListenerPostfetchProcessor(DedupDb(tid=51), started 139806579545856)> shutting down
2023-10-21 18:22:22,467 47 INFO StatsProcessor(tid=52) warcprox.stats.StatsProcessor._get_process_put(__init__.py:207) gathered batch of 1 in 1.52 sec
2023-10-21 18:22:23,006 47 INFO StatsProcessor(tid=52) warcprox.stats.StatsProcessor._run(__init__.py:144) <StatsProcessor(StatsProcessor(tid=52), started 139806570891008)> shutting down
2023-10-21 18:22:23,506 47 INFO CrawlLogger(tid=53) warcprox.BasePostfetchProcessor._run(__init__.py:144) <ListenerPostfetchProcessor(CrawlLogger(tid=53), started 139806218647296)> shutting down
2023-10-21 18:22:23,506 47 INFO RunningStats(tid=54) warcprox.BasePostfetchProcessor._run(__init__.py:144) <ListenerPostfetchProcessor(RunningStats(tid=54), started 139806210254592)> shutting down