j-Serie DS 215j hängt erst einzelne Dienste und sich dann komplett auf

[XPectIT]

Guten Morgen,

nach anfänglichem problemlosen Laufens nervt mich seit ca. 3 Monaten meine DS215j. Seit wann genau das so ist, kann ich allerdings nicht besser eingrenzen. Allerdings geht es mir jetzt so auf den Zeiger, dass ich der Ursache nachgehen will. Aktuell wühle ich mich durch die verschiedenen Logs unter /var/log.

1. Sie lässt sich nicht ordentlich Herunterfahren:
Beim Herunterfahren hängt sie sich auf, und zwar egal ob ich den Ein-/Ausschalter drücke oder über das DSM gehe.
Es scheint so, als blockiert den shutdown Prozess irgendwas Widerspenstiges. Drücke ist den Knopf an der DS fängt die blaue LED das blinken an, noch laufende Dienste (oder das Netzwerk) werden beendet und nach ca. 20 Minuten blinkt die LED immernoch ohne Änderung am Status.
Es hilft nur: ca. 10 Sekunden Knopf drücken.

2. Nach einiger Betriebszeit sind verschiedene Dienste nicht mehr erreichbar.
Mal sind die SMB-Freigaben "weg", mal komme ich nicht mehr ins DSM, ein anderes mal ist die Datenbank (Maria-DB) nicht mehr online.
Wenn die DS zu dem Zeitpunkt gerade im Standby war, wacht sie auch nicht mehr auf. Anpingen im Netzwerk funktioniert aber.
Als es mal wieder das DSM erwischte, habe ich von einem Linux-Rechner ein wget der Einstiegsseite gemacht. Das Merkwürdige daran. Ein Connect funktioniert. Der Client bekommt den Redirect von http://ip:5000 nach http://ip:5000/webman/index.cgi und diese Seite wird nicht ausgeliefert. Timeout.

Zusammen mit Problem 1 ist das extrem ärgerlich, da ich nichtmal einfach die Kiste rebooten kann.

Auf der DS sind keine Pakete von Drittherstellern installiert.
Eingebaut ist eine WD 4TB Caviar Green. Diese hängt am Port 2, der Port 1 ist leer. Da habe ich wohl beim Einbau nicht drauf geachtet. Smart-Werte sind ok und im monatlichen Gesundheitsbericht ist auch alles gut. Ich hab noch eine DS212j (mit 2x 2TB WD Caviar Green) die tadelos läuft.

Ich bin für alle Vorschläge offen und bereichte, wenn ich etwas finde.

Update:
Ein reboot über ssh ging soeben Problemlos.

 

[dil88]

Was steht denn im Logfile im Protokollcenter bzw. in /var/log/messages?

 

[XPectIT]

In der messages steht z.B. für gestern Abend, wo es wieder auftrat, allerdings habe ich da recht schnell den Schalter für 10 Sek gedrückt:

Jul  1 02:00:16 dl kernel: [440371.497231] ata2: link is slow to respond, please be patient (ready=0)
Jul  1 02:00:16 dl kernel: [440374.501025] ata2: wake up successful, the reset fail can be ignored
Jul  1 02:00:11 dl iscsid: Kernel reported iSCSI connection 1:0 error (1011) state (3)
Jul  1 02:00:24 dl iscsid: connection1:0 is operational after recovery (1 attempts)
Jul  1 07:46:18 dl kernel: [461137.903487] ata2: wake up from deepsleep, reset link now
Jul  1 07:46:18 dl kernel: [461137.993447] ata2: device plugged sstatus 0x123
Jul  1 07:46:27 dl kernel: [461146.850801] ata2: link is slow to respond, please be patient (ready=0)
Jul  1 07:46:30 dl kernel: [461149.914576] ata2: wake up successful, the reset fail can be ignored
Jul  1 18:11:00 dl kernel: [498621.843157] ata2: wake up from deepsleep, reset link now
Jul  1 18:11:00 dl kernel: [498621.933166] ata2: device plugged sstatus 0x123
Jul  1 18:11:09 dl kernel: [498630.779282] ata2: link is slow to respond, please be patient (ready=0)
Jul  1 18:11:12 dl kernel: [498633.783069] ata2: wake up successful, the reset fail can be ignored
Jul  1 18:11:13 dl kernel: [498634.594885] init: crond main process (1629) killed by TERM signal
Jul  1 18:11:13 dl kernel: [498634.625011] init: synonetd main process (1729) killed by TERM signal
Jul  1 18:11:13 dl syno_poweroff_task: System is going to poweroff.
Jul  1 18:11:13 dl kernel: [498634.673206] init: synostoraged main process (4676) terminated with status 15
Jul  1 18:11:13 dl kernel: [498634.702551] init: hotplugd main process (4882) killed by TERM signal
Jul  1 18:11:13 dl kernel: [498634.801228] init: smbd main process (31957) killed by TERM signal
Jul  1 18:11:14 dl syno_poweroff_task: service_third_party.c:38 synoservice: stop all packages ...
Jul  1 18:11:18 dl kernel: [498639.481688] init: php-fpm main process (2585) killed by KILL signal
Jul  1 18:11:23 dl kernel: [498644.965543] xs_local_setup_socket: unhandled error (111) connecting to /var/run/rpcbind.sock
Jul  1 18:11:23 dl kernel: [498644.974186] xs_local_setup_socket: unhandled error (111) connecting to /var/run/rpcbind.sock
Jul  1 18:11:23 dl kernel: [498644.983830] xs_local_setup_socket: unhandled error (111) connecting to /var/run/rpcbind.sock
Jul  1 18:11:23 dl kernel: [498644.993005] xs_local_setup_socket: unhandled error (111) connecting to /var/run/rpcbind.sock
Jul  1 18:11:23 dl kernel: [498645.002811] xs_local_setup_socket: unhandled error (111) connecting to /var/run/rpcbind.sock
Jul  1 18:11:23 dl kernel: [498645.011927] nfsd: last server has exited, flushing export cache
rmmod: can't unload 'rpcsec_gss_krb5': Resource temporarily unavailable
Jul  1 18:13:08 dl kernel: [    0.000000] CPU: ARMv7 Processor [414fc091] revision 1 (ARMv7), cr=10c53c7d

Es gibt jedoch kein einheitliches Bild in den Logfiles.
Beispiel 1:

Jun  4 16:42:24 dl index.cgi: index.cpp:312 Renice failed. Permission denied
Jun  4 16:55:21 dl index.cgi: index.cpp:312 Renice failed. Permission denied
Jun  4 21:21:35 dl kernel: [1034847.498982] init: crond main process (1853) killed by TERM signal
Jun  4 21:21:35 dl kernel: [1034847.535453] init: synonetd main process (1958) killed by TERM signal
Jun  4 21:21:35 dl syno_poweroff_task: System is going to reboot.
Jun  4 21:21:35 dl kernel: [1034847.572452] init: synostoraged main process (4885) terminated with status 15
Jun  4 21:21:35 dl kernel: [1034847.595471] init: hotplugd main process (5187) killed by TERM signal
Jun  4 21:21:35 dl kernel: [1034847.607732] init: winbindd main process (6790) killed by TERM signal
Jun  4 21:21:35 dl kernel: [1034847.621992] init: smbd main process (6828) killed by TERM signal
Jun  4 21:21:36 dl syno_poweroff_task: service_third_party.c:38 synoservice: stop all packages ...
Jun  4 21:21:40 dl kernel: [1034852.357214] init: httpd-sys main process (17734) killed by KILL signal
Jun  4 21:21:45 dl kernel: [1034857.502557] xs_local_setup_socket: unhandled error (111) connecting to /var/run/rpcbind.sock
Jun  4 21:21:45 dl kernel: [1034857.511298] xs_local_setup_socket: unhandled error (111) connecting to /var/run/rpcbind.sock
Jun  4 21:21:45 dl kernel: [1034857.520092] xs_local_setup_socket: unhandled error (111) connecting to /var/run/rpcbind.sock
Jun  4 21:21:45 dl kernel: [1034857.528845] xs_local_setup_socket: unhandled error (111) connecting to /var/run/rpcbind.sock
Jun  4 21:21:45 dl kernel: [1034857.537564] nfsd: last server has exited, flushing export cache
Jun  4 21:22:39 dl iscsid: Kernel reported iSCSI connection 2:0 error (1020) state (3)
Jun  4 21:22:42 dl iscsid: connect to 127.0.0.1:12345 failed (Connection refused)
Jun  4 21:22:46 dl iscsid: connect to 127.0.0.1:12345 failed (Connection refused)
...
... ca. 680 mal ...
...
Jun  4 22:06:48 dl iscsid: connect to 127.0.0.1:12345 failed (Connection refused)
Jun  4 22:06:52 dl iscsid: connect to 127.0.0.1:12345 failed (Connection refused)
Jun  4 22:06:56 dl iscsid: connect to 127.0.0.1:12345 failed (Connection refused)
Jun  4 22:08:45 dl kernel: [    0.000000] CPU: ARMv7 Processor [414fc091] revision 1 (ARMv7), cr=10c53c7d

Beispiel 2:

May 23 21:48:51 dl kernel: [430207.060330] ata2: wake up from deepsleep, reset link now
May 23 21:48:51 dl kernel: [430207.150321] ata2: device plugged sstatus 0x123
May 23 21:48:59 dl kernel: [430216.017594] ata2: link is slow to respond, please be patient (ready=0)
May 23 21:49:02 dl kernel: [430219.020767] ata2: wake up successful, the reset fail can be ignored
May 23 21:50:43 dl entry.cgi_SYNO.Core.Upgrade[1].start[3894]: update_cpputil.cpp:806 synoservice: stop all packages ...
May 23 21:51:17 dl synoaudiod: synoaudiod.cpp:2083 synoaudiod exit
May 23 21:51:19 dl scheduler: scheduler.cpp (2216) Got signal. Die gracefully.
May 23 21:51:20 dl synodldbd: synodldbd.cpp:18 Get sig [15] and set gblDaemon to false
May 23 21:51:20 dl synodldbd: socket.c:115 Failed to select [Interrupted system call]
May 23 21:51:20 dl synodldbd: synodldbd.cpp:139 Failed to accept socket
May 23 21:52:33 dl entry.cgi_SYNO.Core.Upgrade[1].start[3894]: update_cpputil.cpp:859 synoservice: finish stopped all packages
May 23 21:52:36 dl kernel: [430432.710562] init: smbd main process (6649) killed by TERM signal
May 23 21:52:43 dl kernel: [430439.522477] init: crond main process (1948) killed by TERM signal
May 23 21:52:45 dl kernel: [430441.677460] nfsd: last server has exited, flushing export cache
killall: synolunbkp: no process killed
May 23 21:52:58 dl kernel: [430454.456605] init: synonetd main process (2072) killed by TERM signal
May 23 21:52:58 dl syno_poweroff_task: System is going to reboot.
May 23 21:52:58 dl kernel: [430454.489817] init: synostoraged main process (5009) terminated with status 15
May 23 21:52:58 dl kernel: [430454.507381] init: hotplugd main process (5349) killed by TERM signal
May 23 21:52:58 dl syno_poweroff_task: service_third_party.c:38 synoservice: stop all packages ...
May 23 21:53:26 dl entry.cgi_SYNO.Core.Upgrade[1].start[3892]: system_sys_init.c:40 System is shutting down, skip reboot request.
May 23 21:54:15 dl syno_poweroff_task: service_third_party.c:57 synoservice: finish stopped all packages
May 23 21:54:17 dl findhostd: si_pid=[1], process=[/sbin/init]
May 23 21:54:17 dl findhostd: findhostd.c:109(FHOSTDProcessNameGet) parameter error
May 23 21:54:17 dl findhostd: findhostd.c:67(FHOSTDExit) exit on signal[15]
May 23 21:54:21 dl root: Check device busy: passed
May 23 21:54:21 dl synocheckshare: synocheckshare_vol_unmount.c:147 Unmount Share [INTERNAL] [/dev/mapper/vol1-origin] [/volume1]
May 23 21:54:22 dl kernel: [430538.318533] ------------[ cut here ]------------
May 23 21:54:22 dl kernel: [430538.323279] WARNING: at fs/namespace.c:848 mntput_no_expire+0xe4/0x118()
May 23 21:54:22 dl kernel: [430538.330132] Modules linked in: usbhid hid usblp usb_storage ds215j_synobios(P) synoacl_vfs(P) hfsplus fuse vfat fat cryptosoft ecryptfs cesa_ocf_drv(P) cryptodev(P) ocf(P) dm_snapshot quota_v2 quota_tree psnap p8022 llc sit tunnel4 ipv6 sg etxhci_hcd xhci_hcd ehci_hcd usbcore usb_common [last unloaded: loop]
May 23 21:54:22 dl kernel: [430538.358088] Backtrace: 
May 23 21:54:22 dl kernel: [430538.360665] [<80011cb4>] (dump_backtrace+0x0/0x110) from [<803ffca0>] (dump_stack+0x18/0x20)
May 23 21:54:22 dl kernel: [430538.369247]  r6:804efd58 r5:00000350 r4:00000000 r3:8056f2d4
May 23 21:54:22 dl kernel: [430538.375086] [<803ffc88>] (dump_stack+0x0/0x20) from [<8007c7c8>] (warn_slowpath_common+0x54/0x70)
May 23 21:54:22 dl kernel: [430538.384109] [<8007c774>] (warn_slowpath_common+0x0/0x70) from [<8007c808>] (warn_slowpath_null+0x24/0x2c)
May 23 21:54:22 dl kernel: [430538.393818]  r8:9fa266e0 r7:8058d948 r6:8058d948 r5:99d55800 r4:9fa266c0
May 23 21:54:22 dl kernel: [430538.400521] r3:00000009
May 23 21:54:22 dl kernel: [430538.403275] [<8007c7e4>] (warn_slowpath_null+0x0/0x2c) from [<80121c0c>] (mntput_no_expire+0xe4/0x118)
May 23 21:54:22 dl kernel: [430538.412731] [<80121b28>] (mntput_no_expire+0x0/0x118) from [<80122d44>] (sys_umount+0x68/0x370)
May 23 21:54:22 dl kernel: [430538.421567]  r7:935ae000 r6:9fa266e0 r5:935aff70 r4:00000000
May 23 21:54:22 dl kernel: [430538.427411] [<80122cdc>] (sys_umount+0x0/0x370) from [<8000dd20>] (ret_fast_syscall+0x0/0x30)
May 23 21:54:22 dl kernel: [430538.436072] ---[ end trace b36a034392077962 ]---
May 23 21:54:22 dl kernel: [430539.056300] md: md2: set sdb5 to auto_remap [0]
May 23 21:55:24 dl kernel: [    0.000000] CPU: ARMv7 Processor [414fc091] revision 1 (ARMv7), cr=10c53c7d

Ich konnte noch nix Konkretes zuordnen.

 

[XPectIT]

Es geht wieder los:
Aktuell ist die Photostation nicht erreichbar. Im Webbrowser passiert garnichts, und mit wget dieses:

ich@rechner:~$ wget http://192.168.77.11/photo
--2015-07-06 10:43:07--  http://192.168.77.11/photo
Verbindungsaufbau zu 192.168.77.11:80... verbunden.
HTTP-Anforderung gesendet, warte auf Antwort... 301 Moved Permanently
Platz: http://192.168.77.11/photo/ [folge]
--2015-07-06 10:43:07--  http://192.168.77.11/photo/
Wiederverwendung der bestehenden Verbindung zu 192.168.77.11:80.
HTTP-Anforderung gesendet, warte auf Antwort...

ps zeigt u.a. dass das Paket gestartet ist:

Datenlager> ps | grep photo
 9896 root      4004 S    grep photo
10695 root     13304 S N  /usr/syno/bin/photostationd
18268 postgres 36932 S    postgres: postgres photo [local] idle

Mich wunder aber der hohe load-wert, wobei beide Prozessoren bei 0-10% schnarchen:

Datenlager> uptime
 10:48:06 up 3 days, 13:15, load average: 55.87, 55.51, 53.70

In der Prozessliste ist die Audiostation (ich wollte die Photostation öffnen) ganz oben zu finden:

Mem: 500256K used, 13408K free, 0K shrd, 22788K buff, 210380K cached
CPU:  3.8% usr  0.9% sys  0.0% nic 94.7% idle  0.3% io  0.0% irq  0.0% sirq
Load average: 55.81 55.69 54.05 1/323 11529
  PID  PPID USER     STAT   VSZ %MEM %CPU COMMAND
10234     1 root     S <  80152 15.5  0.7 /var/packages/AudioStation/target/sbin/synoaudiod

Hat jemand noch einen Tip, was hier vor sich geht?

 

[XPectIT]

Mittlerweile:

Datenlager> uptime
 13:22:07 up 3 days, 15:49, load average: 88.29, 86.25, 82.56

Im DSM kann ist fast nichts mehr machen. Es läd zwar im Browser, aber:
- die Paketverwaltung geht nicht
Es wird angezeigt welche Pakete installiert sind, aber nur Text, keine Bilder.
Bei den anderen (nicht installierten Paketen) erscheint nur "Verbindung fehlgeschlagen, bitte überprüfen Sie ihre Verbindung"

- die Filestation geht nicht
Beim Versuch Ordner zu erstellen, erscheint etwas wie "Operation fehlgeschlagen"

- die Kommandozeile geht nicht richtig

Datenlager> cd netboot_storage/
Datenlager> ls
^C
Datenlager> uptime
 13:22:07 up 3 days, 15:49, load average: 88.29, 86.25, 82.56
Datenlager> pwd
/volume1/netboot_storage
Datenlager> ls
^C

Ich kann z.B. in den Ordner "netboot_storage" wechseln, aber ich kann mir nicht mit "ls" den Inhalt auflisten lassen, weil einfach nichts passiert.
Wechsle ich ein Verzeichnis höher oder woanders hin, dann geht es.

Datenlager> cd ..
Datenlager> ls
@S2S                @eaDir              xxx        xxx               web
@appstore           @img_bkp_repo       xxx              xxx             winbindd_cache.tdb
@autoupdate         @quarantine         aquota.group        netboot_storage
@database           @tmp                aquota.user         xxx
@dms.core           @tmpbtdl            xxx            synoquota.db
@download           xxx                lost+found          xxx
Datenlager> cd photo/
Datenlager> ls
2007_04_xxx        ...
#das geht #

In der messages ist eine verdächtige Stelle:

Jul  6 12:52:12 Datenlager kernel: [314381.088700]  connection1:0: ping timeout of 5 secs expired, recv timeout 5, last rx 31416003, last ping 31416504, now 31417005
Jul  6 12:52:13 Datenlager iscsid: Kernel reported iSCSI connection 1:0 error (1011) state (3)
Jul  6 12:52:24 Datenlager iscsid: connection1:0 is operational after recovery (1 attempts)

Ich bin immernoch ratlos.

 

[XPectIT]

Ich habe jetzt (mal wieder) versucht neu zu starten, aber die DS hängt irgendwo zwischendrin.
In einer ssh-Sitzung habe ich "reboot" eingegeben und die Meldung erhalten, daß das System neustartet. Dann ging die ssh-Sitzung zu (wie erwartet) und jetzt komm ich nicht mehr drauf.

ich@rechner:~$ ssh -l root 192.168.77.11
ssh: connect to host 192.168.77.11 port 22: Connection refused
ich@rechner:~$
ich@rechner:~$ ping -c 3 192.168.77.11
PING 192.168.77.11 (192.168.77.11) 56(84) bytes of data.
64 bytes from 192.168.77.11: icmp_seq=1 ttl=63 time=101 ms
64 bytes from 192.168.77.11: icmp_seq=2 ttl=63 time=116 ms
64 bytes from 192.168.77.11: icmp_seq=3 ttl=63 time=102 ms

--- 192.168.77.11 ping statistics ---
3 packets transmitted, 3 received, 0% packet loss, time 2003ms
rtt min/avg/max/mdev = 101.676/106.851/116.386/6.760 ms

Auf pings antwortet die Kiste jedoch noch. Und das seit ca. 10 Minuten.


Das heißt ich muss jetzt wieder an die DS hin, Power-knopf für 10 Sekunden drücken. Das ist sehr ärgerlich.
Ich bin immernoch ratlos.

 

[XPectIT]

Nachdem die DS gestern morgen beim Neustart nicht neu startete, sondern bockig nurnoch auf Pings antwortete, gibts hier die Logdatei-Auszüge davon.
Um ca. 7:56 Uhr gab ich den reboot befehl ein.
Um ca. 15:30 Uhr drückte ich kurz auf den Power-Knopf (was nur eine blinkende LED auslöste, aber sonst ist augenscheinlich nichts geschehen).
Um ca. 16:15 Uhr drückte ich 10 Sekunden den Power-Knopf um die DS kurz drauf neuzustarten.

In der /var/log/kern.log steht nix bedeutendes.
Hier die /var/log/messages:

Jul  7 07:39:35 Datenlager kernel: [382027.460152] ata2: link is slow to respond, please be patient (ready=0)
Jul  7 07:39:38 Datenlager kernel: [382030.403882] ata2: wake up successful, the reset fail can be ignored
Jul  7 07:56:57 Datenlager kernel: [383069.631427] init: crond main process (1967) killed by TERM signal
Jul  7 07:56:57 Datenlager kernel: [383069.679842] init: synonetd main process (2060) killed by TERM signal
Jul  7 07:56:57 Datenlager syno_poweroff_task: System is going to reboot.
Jul  7 07:56:57 Datenlager kernel: [383069.744595] init: synostoraged main process (5162) terminated with status 15
Jul  7 07:56:57 Datenlager kernel: [383069.817552] init: hotplugd main process (5471) killed by TERM signal
Jul  7 07:56:57 Datenlager kernel: [383069.880760] init: smbd main process (7243) killed by TERM signal
Jul  7 07:56:58 Datenlager syno_poweroff_task: service_third_party.c:38 synoservice: stop all packages ...
Jul  7 07:57:01 Datenlager kernel: [383073.505564] init: php-fpm main process (11742) killed by KILL signal
Jul  7 07:57:02 Datenlager kernel: [383074.563412] init: httpd-user main process (11767) killed by KILL signal
rmmod: can't unload 'nfsd': Resource temporarily unavailable
rmmod: can't unload 'exportfs': Resource temporarily unavailable
rmmod: can't unload 'rpcsec_gss_krb5': Resource temporarily unavailable
Jul  7 16:18:09 Datenlager kernel: [    0.000000] CPU: ARMv7 Processor [414fc091] revision 1 (ARMv7), cr=10c53c7d

In /var/log/synopkg.log fiel mir etwas auf. Bei einem erfolgreichen Neustart sieht es z.B. so aus, wenn der AntiVirus-Dienst gestoppt wird:

2015/07/02 21:31:44	(system) trigger AntiVirus: begin to stop version 1.3-2337
2015/07/02 21:31:45	(system) trigger AntiVirus: stop version 1.3-2337 successfully, result 0

Bei mir sah gibt es für gestern nur eine Zeile um 7:56 Uhr:

2015/07/02 21:36:21	(system) trigger AntiVirus: begin to start version 1.3-2337
2015/07/02 21:36:21	(system) trigger AntiVirus: start version 1.3-2337 successfully, result 0
2015/07/07 07:56:59	(system) trigger AntiVirus: begin to stop version 1.3-2337
2015/07/07 16:18:56	(system) trigger DownloadStation: begin to start version 3.5-2963
2015/07/07 16:19:00	(system) trigger DownloadStation: start version 3.5-2963 successfully, result 0

Auch in der /var/log/synoservice.log steht nur wenig:

Jul  3 16:04:56 Datenlager hotplugd: servicecfg_internal_lib.c:422 synoservice: service [nfsd] reload
Jul  7 07:56:58 Datenlager syno_poweroff_task: service_third_party.c:38 synoservice: stop all packages ...
Jul  7 16:18:13 Datenlager synoservicecfg: service_stop.c:49 synoservice: [synowifid] stopping ...

Nur bringt mich das nicht sonderlich weiter. Einzig die eine Zeile, dass das AntiVirus-Paket zwar anhalten sollte, aber keine Rückmeldung dazu kam, hat mich dazu veranlasst mal dieses zu deinstallieren.

Ich habe auch mal einen Supportfall eröffnet. Mal schauen ob da was rauskommt.
Ratlos bin ich natürlich noch.

Edit:
Es ist niemand Zuhause, die DS hat nix zu tun und trotzdem einen Load der kontinuierlich ansteigt.

Datenlager> uptime
 12:53:49 up 20:36, load average: 1.66, 0.94, 0.83

In der Prozessliste stand wieder die Audiostation ganz oben (wobei ich "normales Indizierungsverhalten" nicht ausschließen kann). Diese habe ich jetzt im DSM-Paketmanager gestoppt, und siehe da:

Datenlager> uptime
 12:59:49 up 20:42, load average: 0.16, 0.61, 0.75

 

[XPectIT]

Leider habe ich mich wohl zufrüh in Sicherheit gedacht.

Stand jetzt:

Datenlager> uptime
 18:52:17 up 6 days,  2:34, load average: 7.00, 6.53, 6.15

Es scheint so, als ob kein Befehl mehr ordentlich abgearbeitet wird, denn

Datenlager> uptime
 18:58:02 up 6 days,  2:40, load average: 9.56, 8.07, 6.90

Datenlager> uptime
 19:09:04 up 6 days,  2:51, load average: 13.71, 12.29, 9.70

der Load erhöht sich quasi permanent. Download-Station geht zwar auf, Aufträge kann ich keine erstellen. Photostation, Anmeldeseite wird nicht aufgebaut.

Der Support hat zwischendurch geantwortet und meinte, ich solle
1. mal mit einer anderen Festplatte testen (was nicht so einfach ist, wenn man keine in der Schublade liegen hat)
2. die DS mal zurücksetzen. Also Reset-Knopf drücken, und danach neu per Setup einrichten.

Dann werde ich das mal machen und hier den Thread updaten.

Noch schnell was aus den Logs /var/log/messages:

Jul 13 00:00:01 Datenlager kernel: [459762.500525] ata2: wake up from deepsleep, reset link now
Jul 13 00:00:13 Datenlager kernel: [459762.590496] ata2: device plugged sstatus 0x123
Jul 13 00:00:13 Datenlager kernel: [459771.447499] ata2: link is slow to respond, please be patient (ready=0)
Jul 13 00:00:13 Datenlager kernel: [459774.391254] ata2: wake up successful, the reset fail can be ignored
Jul 13 00:00:17 Datenlager iscsid: iSCSI logger with pid=3419 started!
Jul 13 00:00:17 Datenlager timebkp: [3422]BK_ERR:try to create SSH tunnel
Jul 13 00:00:18 Datenlager iscsid: transport class version 2.0-870. iscsid version 2.0-871
Jul 13 00:00:18 Datenlager iscsid: iSCSI daemon with pid=3420 started!
Jul 13 00:00:41 Datenlager kernel: [459802.949474] got iSCSI disk[0]
Jul 13 00:00:42 Datenlager iscsid: connection1:0 is operational now
Jul 13 00:00:45 Datenlager [INFO]: /tmp/timebkptmpexec-IngBoB[3447]: suspending snapshot origin [/dev/mapper/vol1-origin] ...
Jul 13 09:01:15 Datenlager kernel: [492238.246789] ata2: wake up from deepsleep, reset link now
Jul 13 09:01:15 Datenlager kernel: [492238.336760] ata2: device plugged sstatus 0x123
Jul 13 09:01:24 Datenlager kernel: [492247.194326] ata2: link is slow to respond, please be patient (ready=0)
Jul 13 09:01:27 Datenlager kernel: [492250.198075] ata2: wake up successful, the reset fail can be ignored
Jul 13 10:03:17 Datenlager kernel: [495960.598837] ata2: wake up from deepsleep, reset link now
Jul 13 10:03:17 Datenlager kernel: [495960.688815] ata2: device plugged sstatus 0x123
Jul 13 10:03:26 Datenlager kernel: [495969.535947] ata2: link is slow to respond, please be patient (ready=0)
Jul 13 10:03:29 Datenlager kernel: [495972.539714] ata2: wake up successful, the reset fail can be ignored
Jul 13 12:09:04 Datenlager kernel: [503508.095671] ata2: wake up from deepsleep, reset link now
Jul 13 12:09:04 Datenlager kernel: [503508.185636] ata2: device plugged sstatus 0x123
Jul 13 12:09:16 Datenlager kernel: [503517.038773] ata2: link is slow to respond, please be patient (ready=0)
Jul 13 12:09:16 Datenlager kernel: [503520.062337] ata2: wake up successful, the reset fail can be ignored
Jul 13 13:55:39 Datenlager kernel: [509903.354383] ata2: wake up from deepsleep, reset link now
Jul 13 13:55:39 Datenlager kernel: [509903.444340] ata2: device plugged sstatus 0x123
Jul 13 13:55:48 Datenlager kernel: [509912.291615] ata2: link is slow to respond, please be patient (ready=0)
Jul 13 13:55:51 Datenlager kernel: [509915.295325] ata2: wake up successful, the reset fail can be ignored
Jul 13 18:24:51 Datenlager kernel: [526055.843468] ata2: wake up from deepsleep, reset link now
Jul 13 18:24:51 Datenlager kernel: [526055.933460] ata2: device plugged sstatus 0x123
Jul 13 18:25:00 Datenlager kernel: [526064.785196] ata2: link is slow to respond, please be patient (ready=0)
Jul 13 18:25:03 Datenlager kernel: [526067.788932] ata2: wake up successful, the reset fail can be ignored
Jul 13 18:50:51 Datenlager kernel: [527616.336190] ata2: wake up from deepsleep, reset link now
Jul 13 18:50:51 Datenlager kernel: [527616.426276] ata2: device plugged sstatus 0x123
Jul 13 18:51:00 Datenlager kernel: [527625.274738] ata2: link is slow to respond, please be patient (ready=0)
Jul 13 18:51:03 Datenlager kernel: [527628.218473] ata2: wake up successful, the reset fail can be ignored