Page 1 of 1

New install on raspbian - queue not downloading

Posted: December 4th, 2013, 4:33 pm
by tn245
Hi

I'm trying to get sabnzbd running on a raspberry pi running raspbian, so I followed these instructions: http://www.howtogeek.com/142249/

Everything looks good and I'm able to access the web interface and add nzb files, but although the status says downloading, the speed just sits at 0kb/s and nothing happens. Server tests ok and it doesn't matter which files I'm trying to download. Downloading works fine on sabnzbd on my desktop machine.

There are some warnings and errors which you can see in the log file below.

Any ideas?

Here's a log file

Code: Select all

2013-12-04 21:15:20,787::INFO::[_cplogging:55] [04/Dec/2013:21:15:20] ENGINE Bus STOPPING
2013-12-04 21:15:20,802::INFO::[_cplogging:55] [04/Dec/2013:21:15:20] ENGINE HTTP Server cherrypy._cpwsgi_server.CPWSGIServer(('0.0.0.0', 8080)) already shut down
2013-12-04 21:15:20,806::INFO::[_cplogging:55] [04/Dec/2013:21:15:20] ENGINE No thread running for _TimeoutMonitor.
2013-12-04 21:15:20,808::INFO::[_cplogging:55] [04/Dec/2013:21:15:20] ENGINE Bus STOPPED
2013-12-04 21:15:20,822::INFO::[_cplogging:55] [04/Dec/2013:21:15:20] ENGINE Bus EXITING
2013-12-04 21:15:20,825::INFO::[_cplogging:55] [04/Dec/2013:21:15:20] ENGINE Bus EXITED
2013-12-04 21:17:40,470::INFO::[__init__:560] Adding Linux Mint 14 Nadia.nzb
2013-12-04 21:17:40,492::INFO::[misc:725] Creating directories: /media/USBDisk/shares/downloading/Linux Mint 14 Nadia.1
2013-12-04 21:17:40,520::DEBUG::[__init__:769] Saving data for SABnzbd_nzf_Ez_eYh in /media/USBDisk/shares/downloading/Linux Mint 14 Nadia.1/__ADMIN__
2013-12-04 21:17:40,532::INFO::[nzbstuff:423] File Linux_Mint_14_Nadia_Mate_32_bit.zip (1/1) added to queue
2013-12-04 21:17:40,536::INFO::[__init__:516] Backing up /media/USBDisk/shares/nzb-backup/Linux Mint 14 Nadia.nzb.gz
2013-12-04 21:17:40,556::INFO::[__init__:516] Backing up /media/USBDisk/shares/downloading/Linux Mint 14 Nadia.1/__ADMIN__/Linux Mint 14 Nadia.nzb.gz
2013-12-04 21:17:40,602::INFO::[nzbqueue:170] Saving queue
2013-12-04 21:17:40,605::DEBUG::[__init__:769] Saving data for SABnzbd_nzo_CvoX2o in /media/USBDisk/shares/downloading/Linux Mint 14 Nadia.1/__ADMIN__
2013-12-04 21:17:40,652::INFO::[__init__:846] Saving data for queue9.sab in /home/pi/.sabnzbd/admin/queue9.sab
2013-12-04 21:28:16,976::INFO::[_cplogging:55] [04/Dec/2013:21:28:16] ENGINE Bus STOPPING
2013-12-04 21:28:16,986::INFO::[_cplogging:55] [04/Dec/2013:21:28:16] ENGINE HTTP Server cherrypy._cpwsgi_server.CPWSGIServer(('0.0.0.0', 8080)) already shut down
2013-12-04 21:28:16,994::INFO::[_cplogging:55] [04/Dec/2013:21:28:16] ENGINE No thread running for _TimeoutMonitor.
2013-12-04 21:28:16,997::INFO::[_cplogging:55] [04/Dec/2013:21:28:16] ENGINE Bus STOPPED
2013-12-04 21:28:17,006::INFO::[_cplogging:55] [04/Dec/2013:21:28:17] ENGINE Bus EXITING
2013-12-04 21:28:17,014::INFO::[_cplogging:55] [04/Dec/2013:21:28:17] ENGINE Bus EXITED
2013-12-04 21:31:11,523::INFO::[_cplogging:55] [04/Dec/2013:21:31:11] ENGINE Bus STARTING
2013-12-04 21:31:11,667::INFO::[_cplogging:55] [04/Dec/2013:21:31:11] ENGINE Started monitor thread '_TimeoutMonitor'.
2013-12-04 21:32:07,958::ERROR::[_cplogging:55] [04/Dec/2013:21:32:07] ENGINE Error in 'start' listener <bound method Server.start of <cherrypy._cpserver.Server object at 0x24046b0>>
Traceback (most recent call last):
  File "/usr/share/sabnzbdplus/cherrypy/process/wspbus.py", line 147, in publish
    output.append(listener(*args, **kwargs))
  File "/usr/share/sabnzbdplus/cherrypy/_cpserver.py", line 90, in start
    ServerAdapter.start(self)
  File "/usr/share/sabnzbdplus/cherrypy/process/servers.py", line 62, in start
    self.wait()
  File "/usr/share/sabnzbdplus/cherrypy/process/servers.py", line 103, in wait
    wait_for_occupied_port(host, port)
  File "/usr/share/sabnzbdplus/cherrypy/process/servers.py", line 275, in wait_for_occupied_port
    raise IOError("Port %r not bound on %r" % (port, host))
IOError: Port 8080 not bound on '0.0.0.0'

2013-12-04 21:32:07,975::ERROR::[_cplogging:55] [04/Dec/2013:21:32:07] ENGINE Shutting down due to error in start listener:
Traceback (most recent call last):
  File "/usr/share/sabnzbdplus/cherrypy/process/wspbus.py", line 184, in start
    self.publish('start')
  File "/usr/share/sabnzbdplus/cherrypy/process/wspbus.py", line 147, in publish
    output.append(listener(*args, **kwargs))
  File "/usr/share/sabnzbdplus/cherrypy/_cpserver.py", line 90, in start
    ServerAdapter.start(self)
  File "/usr/share/sabnzbdplus/cherrypy/process/servers.py", line 62, in start
    self.wait()
  File "/usr/share/sabnzbdplus/cherrypy/process/servers.py", line 103, in wait
    wait_for_occupied_port(host, port)
  File "/usr/share/sabnzbdplus/cherrypy/process/servers.py", line 275, in wait_for_occupied_port
    raise IOError("Port %r not bound on %r" % (port, host))
IOError: Port 8080 not bound on '0.0.0.0'

2013-12-04 21:32:07,979::INFO::[_cplogging:55] [04/Dec/2013:21:32:07] ENGINE Bus STOPPING
2013-12-04 21:32:07,982::INFO::[_cplogging:55] [04/Dec/2013:21:32:07] ENGINE HTTP Server cherrypy._cpwsgi_server.CPWSGIServer(('0.0.0.0', 8080)) already shut down
2013-12-04 21:32:08,048::INFO::[_cplogging:55] [04/Dec/2013:21:32:08] ENGINE Stopped thread '_TimeoutMonitor'.
2013-12-04 21:32:08,051::INFO::[_cplogging:55] [04/Dec/2013:21:32:08] ENGINE Bus STOPPED
2013-12-04 21:32:08,058::INFO::[_cplogging:55] [04/Dec/2013:21:32:08] ENGINE Bus EXITING
2013-12-04 21:32:08,061::INFO::[_cplogging:55] [04/Dec/2013:21:32:08] ENGINE Bus EXITED
2013-12-04 21:32:08,072::ERROR::[sabnzbdplus:1405] Failed to start web-interface: 
Traceback (most recent call last):
  File "/usr/bin/sabnzbdplus", line 1397, in main
    cherrypy.engine.start()
  File "/usr/share/sabnzbdplus/cherrypy/process/wspbus.py", line 184, in start
    self.publish('start')
  File "/usr/share/sabnzbdplus/cherrypy/process/wspbus.py", line 147, in publish
    output.append(listener(*args, **kwargs))
  File "/usr/share/sabnzbdplus/cherrypy/_cpserver.py", line 90, in start
    ServerAdapter.start(self)
  File "/usr/share/sabnzbdplus/cherrypy/process/servers.py", line 62, in start
    self.wait()
  File "/usr/share/sabnzbdplus/cherrypy/process/servers.py", line 103, in wait
    wait_for_occupied_port(host, port)
  File "/usr/share/sabnzbdplus/cherrypy/process/servers.py", line 275, in wait_for_occupied_port
    raise IOError("Port %r not bound on %r" % (port, host))
IOError: Port 8080 not bound on '0.0.0.0'
2013-12-04 21:32:08,097::ERROR::[sabnzbdplus:302] Failed to start web-interface : Port 8080 not bound on '0.0.0.0'

Re: New install on raspbian - queue not downloading

Posted: December 5th, 2013, 12:40 am
by sander
I would first solve the "IOError: Port 8080 not bound on '0.0.0.0'" errors. So, are the errors gone if you start like this:

sabnzbdplus --server 0.0.0.0:8765

If not, does this solve it:

sabnzbdplus --server 127.0.0.1

Re: New install on raspbian - queue not downloading

Posted: December 5th, 2013, 4:05 am
by tn245
Thanks, if I try the first one, I get the same errors with the different port.

sabnzbdplus --server 127.0.0.1 gives me

Code: Select all

error: [Errno 99] Cannot assign requested address
Full output:

Code: Select all

pi@raspberrypi ~ $ sabnzbdplus --server 127.0.0.1
2013-12-05 09:00:14,276::INFO::[sabnzbdplus:1195] --------------------------------
2013-12-05 09:00:14,291::INFO::[sabnzbdplus:1196] sabnzbdplus-0.6.15 (rev=d06f957a0f05a8766822acaa6de1f6d1e9f279e0)
2013-12-05 09:00:14,309::INFO::[sabnzbdplus:1208] Platform = posix
2013-12-05 09:00:14,320::INFO::[sabnzbdplus:1209] Python-version = 2.7.3 (default, Jan 13 2013, 11:20:46) 
[GCC 4.6.3]
2013-12-05 09:00:14,338::INFO::[sabnzbdplus:1210] Arguments = "/usr/bin/sabnzbdplus", "--server", "127.0.0.1"
2013-12-05 09:00:14,348::INFO::[sabnzbdplus:1223] Read INI file /home/pi/.sabnzbd/sabnzbd.ini
2013-12-05 09:00:14,454::INFO::[__init__:870] Loading data for bookmarks.sab from /home/pi/.sabnzbd/admin/bookmarks.sab
2013-12-05 09:00:14,474::INFO::[__init__:870] Loading data for rss_data.sab from /home/pi/.sabnzbd/admin/rss_data.sab
2013-12-05 09:00:14,487::INFO::[__init__:870] Loading data for totals9.sab from /home/pi/.sabnzbd/admin/totals9.sab
2013-12-05 09:00:14,498::INFO::[__init__:873] /home/pi/.sabnzbd/admin/totals9.sab missing, trying old cache
2013-12-05 09:00:14,508::INFO::[__init__:876] /home/pi/.sabnzbd/cache/totals9.sab missing
2013-12-05 09:00:14,632::INFO::[postproc:89] Loading postproc queue
2013-12-05 09:00:14,650::INFO::[__init__:870] Loading data for postproc1.sab from /home/pi/.sabnzbd/admin/postproc1.sab
2013-12-05 09:00:14,668::INFO::[__init__:870] Loading data for queue9.sab from /home/pi/.sabnzbd/admin/queue9.sab
2013-12-05 09:00:14,692::INFO::[__init__:870] Loading data for watched_data.sab from /home/pi/.sabnzbd/admin/watched_data.sab
2013-12-05 09:00:14,718::INFO::[downloader:194] Resuming
2013-12-05 09:00:14,891::INFO::[__init__:289] All processes started
2013-12-05 09:00:14,903::INFO::[sabnzbdplus:332] Web dir is /usr/share/sabnzbdplus/interfaces/Plush
2013-12-05 09:00:15,077::INFO::[sabnzbdplus:442] _yenc module... found!
2013-12-05 09:00:15,087::INFO::[sabnzbdplus:450] par2 binary... found (/usr/bin/par2)
2013-12-05 09:00:15,096::INFO::[sabnzbdplus:458] unrar binary... found (/usr/bin/unrar)
2013-12-05 09:00:15,106::INFO::[sabnzbdplus:463] unzip binary... found (/usr/bin/unzip)
2013-12-05 09:00:15,115::INFO::[sabnzbdplus:469] nice binary... found (/usr/bin/nice)
2013-12-05 09:00:15,124::INFO::[sabnzbdplus:473] ionice binary... found (/usr/bin/ionice)
2013-12-05 09:00:15,134::INFO::[sabnzbdplus:478] pyOpenSSL... found (True)
2013-12-05 09:00:15,166::INFO::[sabnzbdplus:1390] Starting web-interface on 127.0.0.1:8765
2013-12-05 09:00:16,179::INFO::[_cplogging:55] [05/Dec/2013:09:00:16] ENGINE Bus STARTING
2013-12-05 09:00:16,255::INFO::[_cplogging:55] [05/Dec/2013:09:00:16] ENGINE Started monitor thread '_TimeoutMonitor'.
2013-12-05 09:00:16,469::ERROR::[_cplogging:55] [05/Dec/2013:09:00:16] ENGINE Error in HTTP server: shutting down
Traceback (most recent call last):
  File "/usr/share/sabnzbdplus/cherrypy/process/servers.py", line 75, in _start_http_thread
    self.httpserver.start()
  File "/usr/share/sabnzbdplus/cherrypy/wsgiserver/__init__.py", line 1644, in start
    raise socket.error, msg
error: [Errno 99] Cannot assign requested address

2013-12-05 09:00:16,521::INFO::[_cplogging:55] [05/Dec/2013:09:00:16] ENGINE Bus STOPPING
2013-12-05 09:00:16,536::INFO::[_cplogging:55] [05/Dec/2013:09:00:16] ENGINE HTTP Server cherrypy._cpwsgi_server.CPWSGIServer(('127.0.0.1', 8765)) already shut down
2013-12-05 09:00:16,501::ERROR::[_cplogging:55] [05/Dec/2013:09:00:16] ENGINE Error in 'start' listener <bound method Server.start of <cherrypy._cpserver.Server object at 0x2172e10>>
Traceback (most recent call last):
  File "/usr/share/sabnzbdplus/cherrypy/process/wspbus.py", line 147, in publish
    output.append(listener(*args, **kwargs))
  File "/usr/share/sabnzbdplus/cherrypy/_cpserver.py", line 90, in start
    ServerAdapter.start(self)
  File "/usr/share/sabnzbdplus/cherrypy/process/servers.py", line 62, in start
    self.wait()
  File "/usr/share/sabnzbdplus/cherrypy/process/servers.py", line 97, in wait
    raise self.interrupt
error: [Errno 99] Cannot assign requested address

2013-12-05 09:00:16,559::ERROR::[_cplogging:55] [05/Dec/2013:09:00:16] ENGINE Shutting down due to error in start listener:
Traceback (most recent call last):
  File "/usr/share/sabnzbdplus/cherrypy/process/wspbus.py", line 184, in start
    self.publish('start')
  File "/usr/share/sabnzbdplus/cherrypy/process/wspbus.py", line 147, in publish
    output.append(listener(*args, **kwargs))
  File "/usr/share/sabnzbdplus/cherrypy/_cpserver.py", line 90, in start
    ServerAdapter.start(self)
  File "/usr/share/sabnzbdplus/cherrypy/process/servers.py", line 62, in start
    self.wait()
  File "/usr/share/sabnzbdplus/cherrypy/process/servers.py", line 97, in wait
    raise self.interrupt
error: [Errno 99] Cannot assign requested address

2013-12-05 09:00:16,583::INFO::[_cplogging:55] [05/Dec/2013:09:00:16] ENGINE Bus STOPPING
2013-12-05 09:00:16,596::INFO::[_cplogging:55] [05/Dec/2013:09:00:16] ENGINE HTTP Server cherrypy._cpwsgi_server.CPWSGIServer(('127.0.0.1', 8765)) already shut down
2013-12-05 09:00:16,623::INFO::[_cplogging:55] [05/Dec/2013:09:00:16] ENGINE Stopped thread '_TimeoutMonitor'.
2013-12-05 09:00:16,638::INFO::[_cplogging:55] [05/Dec/2013:09:00:16] ENGINE Bus STOPPED
2013-12-05 09:00:16,630::INFO::[_cplogging:55] [05/Dec/2013:09:00:16] ENGINE Stopped thread '_TimeoutMonitor'.
2013-12-05 09:00:16,652::INFO::[_cplogging:55] [05/Dec/2013:09:00:16] ENGINE Bus STOPPED
2013-12-05 09:00:16,662::INFO::[_cplogging:55] [05/Dec/2013:09:00:16] ENGINE Bus EXITING
2013-12-05 09:00:16,670::INFO::[_cplogging:55] [05/Dec/2013:09:00:16] ENGINE Bus EXITING
2013-12-05 09:00:16,682::INFO::[_cplogging:55] [05/Dec/2013:09:00:16] ENGINE Bus EXITED
2013-12-05 09:00:16,693::INFO::[_cplogging:55] [05/Dec/2013:09:00:16] ENGINE Bus EXITED
Exception in thread HTTPServer Thread-9:
Traceback (most recent call last):
  File "/usr/lib/python2.7/threading.py", line 552, in __bootstrap_inner
    self.run()
  File "/usr/lib/python2.7/threading.py", line 505, in run
    self.__target(*self.__args, **self.__kwargs)
  File "/usr/share/sabnzbdplus/cherrypy/process/servers.py", line 75, in _start_http_thread
    self.httpserver.start()
  File "/usr/share/sabnzbdplus/cherrypy/wsgiserver/__init__.py", line 1644, in start
    raise socket.error, msg
error: [Errno 99] Cannot assign requested address

2013-12-05 09:00:16,718::ERROR::[sabnzbdplus:1405] Failed to start web-interface: 
Traceback (most recent call last):
  File "/usr/bin/sabnzbdplus", line 1397, in main
    cherrypy.engine.start()
  File "/usr/share/sabnzbdplus/cherrypy/process/wspbus.py", line 184, in start
    self.publish('start')
  File "/usr/share/sabnzbdplus/cherrypy/process/wspbus.py", line 147, in publish
    output.append(listener(*args, **kwargs))
  File "/usr/share/sabnzbdplus/cherrypy/_cpserver.py", line 90, in start
    ServerAdapter.start(self)
  File "/usr/share/sabnzbdplus/cherrypy/process/servers.py", line 62, in start
    self.wait()
  File "/usr/share/sabnzbdplus/cherrypy/process/servers.py", line 97, in wait
    raise self.interrupt
error: [Errno 99] Cannot assign requested address
2013-12-05 09:00:16,764::ERROR::[sabnzbdplus:302] Failed to start web-interface : [Errno 99] Cannot assign requested address
2013-12-05 09:00:16,781::INFO::[panic:243] Lauching browser with /tmp/tmp1C3so6.html
2013-12-05 09:00:16,798::INFO::[__init__:325] SABnzbd shutting down...
2013-12-05 09:00:16,808::INFO::[__init__:846] Saving data for bookmarks.sab in /home/pi/.sabnzbd/admin/bookmarks.sab
2013-12-05 09:00:16,825::INFO::[urlgrabber:70] URLGrabber shutting down
2013-12-05 09:00:16,834::INFO::[__init__:846] Saving data for watched_data.sab in /home/pi/.sabnzbd/admin/watched_data.sab
2013-12-05 09:00:16,852::INFO::[dirscanner:254] Dirscanner shutting down
2013-12-05 09:00:16,863::INFO::[postproc:83] Saving postproc queue
2013-12-05 09:00:16,876::INFO::[__init__:846] Saving data for postproc1.sab in /home/pi/.sabnzbd/admin/postproc1.sab
2013-12-05 09:00:16,890::INFO::[nzbqueue:170] Saving queue
2013-12-05 09:00:16,899::INFO::[__init__:846] Saving data for queue9.sab in /home/pi/.sabnzbd/admin/queue9.sab
2013-12-05 09:00:16,918::INFO::[__init__:846] Saving data for rss_data.sab in /home/pi/.sabnzbd/admin/rss_data.sab
2013-12-05 09:00:16,935::INFO::[__init__:846] Saving data for bookmarks.sab in /home/pi/.sabnzbd/admin/bookmarks.sab
2013-12-05 09:00:16,953::INFO::[__init__:846] Saving data for watched_data.sab in /home/pi/.sabnzbd/admin/watched_data.sab
2013-12-05 09:00:16,967::INFO::[postproc:83] Saving postproc queue
2013-12-05 09:00:16,977::INFO::[__init__:846] Saving data for postproc1.sab in /home/pi/.sabnzbd/admin/postproc1.sab
2013-12-05 09:00:16,994::INFO::[__init__:385] All processes stopped

Re: New install on raspbian - queue not downloading

Posted: December 5th, 2013, 6:25 am
by sander
That looks quite bad. Have you installed a firewall on your Raspi?

What do you get when you "ping 127.0.0.1"?

Re: New install on raspbian - queue not downloading

Posted: December 5th, 2013, 10:30 am
by tn245
Yeah, looks like my network settings were bad. Something I must have got wrong setting up rasbian. After starting fresh with a clean install it's all working nicely now. Thanks!

Re: New install on raspbian - queue not downloading

Posted: December 6th, 2013, 1:38 am
by sander
Cool. Good to hear.