[strace] 0kb 00001.ts

TheChief · April 25, 2018 at 1:15 PM

Hm, hier irgendwo liegt der Hund begraben:

Code

Apr 25 11:02:00 rec18 vdr: [18604] ERROR: video data stream broken
Apr 25 11:02:00 rec18 vdr: [18604] initiating emergency exit
Apr 25 11:02:00 rec18 vdr: [18590] emergency exit requested - shutting down

kls · April 25, 2018 at 8:07 PM

Tut mir leid, da fällt mir jetzt auch nichts mehr dazu ein.

Wenn mit einem einzigen Device streamdev einen Kanal liefert, dann müsste auch VDR aufnehmen können.

Jetzt müssen wir wohl etwas Debug-Aufwand betreiben.

Füge bitte mal in device.c in der Funktion cDevice::Action() diese Zeile ein:

Code

                 for (int i = 0; i < MAXRECEIVERS; i++) {
                     fprintf(stderr, " %d", i);//XXX
                     cMutexLock MutexLock(&mutexReceiver);

Da werden sehr viele Ausgaben entstehen (also nicht ins Logfile schreiben lassen ;-). Worum es mir geht ist, ob da immer nur die gleiche Zahl kommt oder verschiedene. Du brauchst nicht die gesamte Ausgaben zu posten, sondern nur die (evtl. unterschiedlichen) Zahlenwerte.

Klaus

chrisz · May 8, 2018 at 2:20 PM

Hallo Klaus,

sorry für den delay.

Kann es sein das ich nicht in die Funktion (den for loop) hineinlaufe ? Keinerlei Logging...

Edit: Moment, ich checke das...

kls · May 8, 2018 at 2:23 PM

Das kann eigentlich nicht sein, denn das ist die zentrale Verteilstelle für TS-Pakete.

Die Ausgabe erfolgt nach stdout, nicht ins Logfile!

- Zeile an der richtigen Stelle eingefügt?

- device.c neu übersetzt und vdr gelinkt?

- VDR neu gestartet?

Klaus

chrisz · May 8, 2018 at 2:39 PM

Code

void cDevice::Action(void)
{

dsyslog("FOO-DBG [001] cDevice::Action"); // XXX

  if (Running() && OpenDvr()) {

     dsyslog("FOO-DBG [002] Running"); // XXX

     while (Running()) {

           dsyslog("FOO-DBG [003] Running"); // XXX
           // Read data from the DVR device:
           uchar *b = NULL;
           if (GetTSPacket(b)) {

              dsyslog("FOO-DBG [004] GetTSPacket"); // XXX
              if (b) {

                 dsyslog("FOO-DBG [005] d"); // XXX
                 // Distribute the packet to all attached receivers:
                 Lock();
                 cCamSlot *cs = CamSlot();
                 if (cs)
                    dsyslog("FOO-DBG [006] cs"); // XXX
                    cs->TsPostProcess(b);
                 int Pid = TsPid(b);
                 bool IsScrambled = TsIsScrambled(b);

                dsyslog("FOO-DBG-MAXRECEIVERS: %d", MAXRECEIVERS);

                 for (int i = 0; i < MAXRECEIVERS; i++) {

Display More

syslog:

Code

May  8 14:36:51 rec18 vdr: [8542] timer 1 (1 1400-1500 'DBG-TEST-001') start
May  8 14:36:51 rec18 vdr: [8542] Title: 'Schloss Einstein - Erfurt' Subtitle: '(null)'
May  8 14:36:51 rec18 vdr: [8542] record /srv/video/DBG-TEST-001/2018-05-08.14.00.1-0.rec
May  8 14:36:51 rec18 vdr: [8542] cFileName::SetOffset: removing zero-sized file /srv/video/DBG-TEST-001/2018-05-08.14.00.1-0.rec/00001.ts
May  8 14:36:51 rec18 vdr: [8542] recording to '/srv/video/DBG-TEST-001/2018-05-08.14.00.1-0.rec/00001.ts'
May  8 14:36:51 rec18 vdr: [8542] writing timer id '1@rec18' to /srv/video/DBG-TEST-001/2018-05-08.14.00.1-0.rec/.timer
May  8 14:36:51 rec18 vdr: [8552] device 1 receiver thread started (pid=8542, tid=8552, prio=high)
May  8 14:36:51 rec18 vdr: [8552] FOO-DBG [001] cDevice::Action
May  8 14:36:51 rec18 vdr: [8552] FOO-DBG [002] Running
May  8 14:36:51 rec18 vdr: [8552] FOO-DBG [003] Running
May  8 14:36:51 rec18 vdr: [8553] device 1 TS buffer thread started (pid=8542, tid=8553, prio=high)
May  8 14:36:51 rec18 vdr: [8551] recording thread started (pid=8542, tid=8551, prio=high)
May  8 14:36:51 rec18 vdr: [8542] ERROR: Kanal blockiert (zeichnet auf)!
May  8 14:36:52 rec18 vdr: [8552] FOO-DBG [004] GetTSPacket
May  8 14:36:52 rec18 vdr: [8552] FOO-DBG [003] Running
May  8 14:36:52 rec18 vdr: [8552] FOO-DBG [004] GetTSPacket
May  8 14:36:52 rec18 vdr: [8552] FOO-DBG [003] Running
May  8 14:36:52 rec18 vdr: [8552] FOO-DBG [004] GetTSPacket
May  8 14:36:52 rec18 vdr: [8552] FOO-DBG [003] Running
May  8 14:36:52 rec18 vdr: [8552] FOO-DBG [004] GetTSPacket
May  8 14:36:52 rec18 vdr: [8552] FOO-DBG [003] Running
May  8 14:36:52 rec18 vdr: [8552] FOO-DBG [004] GetTSPacket
May  8 14:36:52 rec18 vdr: [8552] FOO-DBG [003] Running
May  8 14:36:52 rec18 vdr: [8552] FOO-DBG [004] GetTSPacket
May  8 14:36:52 rec18 vdr: [8552] FOO-DBG [003] Running
May  8 14:36:52 rec18 vdr: [8552] FOO-DBG [004] GetTSPacket
May  8 14:36:52 rec18 vdr: [8552] FOO-DBG [003] Running
May  8 14:36:52 rec18 vdr: [8552] FOO-DBG [004] GetTSPacket
May  8 14:36:52 rec18 vdr: [8552] FOO-DBG [003] Running
May  8 14:36:52 rec18 vdr: [8552] FOO-DBG [004] GetTSPacket
May  8 14:36:52 rec18 vdr: [8552] FOO-DBG [003] Running
May  8 14:36:52 rec18 vdr: [8552] FOO-DBG [004] GetTSPacket
May  8 14:36:52 rec18 vdr: [8552] FOO-DBG [003] Running
May  8 14:36:53 rec18 vdr: [8552] FOO-DBG [004] GetTSPacket
May  8 14:36:53 rec18 vdr: [8552] FOO-DBG [003] Running
May  8 14:36:53 rec18 vdr: [8552] FOO-DBG [004] GetTSPacket
May  8 14:36:53 rec18 vdr: [8552] FOO-DBG [003] Running
May  8 14:36:53 rec18 vdr: [8552] FOO-DBG [004] GetTSPacket
May  8 14:36:53 rec18 vdr: [8552] FOO-DBG [003] Running

Display More

chrisz · May 8, 2018 at 2:51 PM

So siehts aus, wenn ich per Streamdev den Kanal streame:

Code

May  8 14:50:26 rec18 vdr: [10160] FOO-DBG [004] GetTSPacket
May  8 14:50:26 rec18 vdr: [10160] FOO-DBG [003] Running
May  8 14:50:26 rec18 vdr: [10160] FOO-DBG [004] GetTSPacket
May  8 14:50:26 rec18 vdr: [10160] FOO-DBG [003] Running
May  8 14:50:26 rec18 vdr: [10160] FOO-DBG [004] GetTSPacket
May  8 14:50:26 rec18 vdr: [10160] FOO-DBG [003] Running
May  8 14:50:26 rec18 vdr: [10160] FOO-DBG [004] GetTSPacket
May  8 14:50:26 rec18 vdr: [10160] FOO-DBG [003] Running
May  8 14:50:26 rec18 vdr: [10160] FOO-DBG [004] GetTSPacket
May  8 14:50:26 rec18 vdr: [10160] FOO-DBG [003] Running
May  8 14:50:26 rec18 vdr: [10160] FOO-DBG [004] GetTSPacket
May  8 14:50:26 rec18 vdr: [10160] FOO-DBG [003] Running
May  8 14:50:27 rec18 vdr: [10160] FOO-DBG [004] GetTSPacket
May  8 14:50:27 rec18 vdr: [10160] FOO-DBG [003] Running
May  8 14:50:27 rec18 vdr: [10160] FOO-DBG [004] GetTSPacket
May  8 14:50:27 rec18 vdr: [10160] FOO-DBG [003] Running
May  8 14:50:27 rec18 vdr: [10150] max. latency time 2 seconds
May  8 14:50:27 rec18 vdr: [10160] FOO-DBG [004] GetTSPacket
May  8 14:50:27 rec18 vdr: [10160] FOO-DBG [003] Running
May  8 14:50:27 rec18 vdr: [10160] FOO-DBG [004] GetTSPacket
May  8 14:50:27 rec18 vdr: [10160] FOO-DBG [003] Running
May  8 14:50:27 rec18 vdr: [10160] FOO-DBG [004] GetTSPacket
May  8 14:50:27 rec18 vdr: [10160] FOO-DBG [003] Running
May  8 14:50:27 rec18 vdr: [10160] FOO-DBG [004] GetTSPacket
May  8 14:50:27 rec18 vdr: [10160] FOO-DBG [003] Running
May  8 14:50:27 rec18 vdr: [10157] Streamdev: Accepted new client (HTTP) 192.168.181.107:56463
May  8 14:50:27 rec18 vdr: [10163] streamdev-livestreaming thread started (pid=10150, tid=10163, prio=high)
May  8 14:50:27 rec18 vdr: [10162] streamdev-writer thread started (pid=10150, tid=10162, prio=high)
May  8 14:50:27 rec18 vdr: [10160] FOO-DBG [004] GetTSPacket
May  8 14:50:27 rec18 vdr: [10160] FOO-DBG [003] Running
May  8 14:50:27 rec18 vdr: [10160] FOO-DBG [004] GetTSPacket
May  8 14:50:27 rec18 vdr: [10160] FOO-DBG [003] Running
May  8 14:50:27 rec18 vdr: [10160] FOO-DBG [004] GetTSPacket
May  8 14:50:27 rec18 vdr: [10160] FOO-DBG [005] d
May  8 14:50:27 rec18 vdr: [10160] FOO-DBG 0
May  8 14:50:27 rec18 vdr: [10160] FOO-DBG 1
May  8 14:50:27 rec18 vdr: [10160] FOO-DBG 2
May  8 14:50:27 rec18 vdr: [10160] FOO-DBG 3
May  8 14:50:27 rec18 vdr: [10160] FOO-DBG 4
May  8 14:50:27 rec18 vdr: [10160] FOO-DBG 5
May  8 14:50:27 rec18 vdr: [10160] FOO-DBG 6
May  8 14:50:27 rec18 vdr: [10160] FOO-DBG 7
May  8 14:50:27 rec18 vdr: [10160] FOO-DBG 8
May  8 14:50:27 rec18 vdr: [10160] FOO-DBG 9
May  8 14:50:27 rec18 vdr: [10160] FOO-DBG 10
May  8 14:50:27 rec18 vdr: [10160] FOO-DBG 11
May  8 14:50:27 rec18 vdr: [10160] FOO-DBG 12
May  8 14:50:27 rec18 vdr: [10160] FOO-DBG 13
May  8 14:50:27 rec18 vdr: [10160] FOO-DBG 14
May  8 14:50:27 rec18 vdr: [10160] FOO-DBG 15
May  8 14:50:27 rec18 vdr: [10160] FOO-DBG [003] Running
May  8 14:50:27 rec18 vdr: [10160] FOO-DBG [004] GetTSPacket
May  8 14:50:27 rec18 vdr: [10160] FOO-DBG [005] d
May  8 14:50:27 rec18 vdr: [10160] FOO-DBG 0
May  8 14:50:27 rec18 vdr: [10160] FOO-DBG 1
May  8 14:50:27 rec18 vdr: [10160] FOO-DBG 2
May  8 14:50:27 rec18 vdr: [10160] FOO-DBG 3
May  8 14:50:27 rec18 vdr: [10160] FOO-DBG 4
May  8 14:50:27 rec18 vdr: [10160] FOO-DBG 5
May  8 14:50:27 rec18 vdr: [10160] FOO-DBG 6
May  8 14:50:27 rec18 vdr: [10160] FOO-DBG 7
May  8 14:50:27 rec18 vdr: [10160] FOO-DBG 8
May  8 14:50:27 rec18 vdr: [10160] FOO-DBG 9
May  8 14:50:27 rec18 vdr: [10160] FOO-DBG 10
May  8 14:50:27 rec18 vdr: [10160] FOO-DBG 11
May  8 14:50:27 rec18 vdr: [10160] FOO-DBG 12
May  8 14:50:27 rec18 vdr: [10160] FOO-DBG 13
May  8 14:50:27 rec18 vdr: [10160] FOO-DBG 14
May  8 14:50:27 rec18 vdr: [10160] FOO-DBG 15
May  8 14:50:27 rec18 vdr: [10160] FOO-DBG [003] Running
May  8 14:50:27 rec18 vdr: [10160] FOO-DBG [004] GetTSPacket
May  8 14:50:27 rec18 vdr: [10160] FOO-DBG [005] d

Display More

kls · May 8, 2018 at 3:42 PM

Und prompt sehe ich natürlich, dass meine Ausgabe drei Zeilen weiter hinten reingehört hätte:

Code

for (int i = 0; i < MAXRECEIVERS; i++) {
                     cMutexLock MutexLock(&mutexReceiver);
                     cReceiver *Receiver = receiver[i];
                     if (Receiver && Receiver->WantsPid(Pid)) {
                        fprintf(stderr, " %d", i);//XXX
                        Receiver->Receive(b, TS_SIZE);

Ist aber egal, denn so wie es aussieht kommen überhaupt keine TS-Pakete an (kein "FOO-DBG [005] d").

Warum sich das in den beiden Fällen unterschiedlich verhält kann ich mir leider auch nicht erklären.

Klaus

chrisz · May 9, 2018 at 10:26 AM

Okay, wenn du Dir das nicht erklären kannst, wer denn dann

Viele Grüße. Ich setzte das ganze nochmal auf einem fresh System auf. Bleibe aber bei Debian stretch und der Digital Devices v7.

TomJoad · May 9, 2018 at 11:45 AM

Mich irritiert das "ERROR: Kanal blockiert (zeichnet auf)!". Vielleicht ist doch etwas besonderes an deiner setup.conf oder Aufrufparametern von vdr und Plugins.

TheChief · May 9, 2018 at 12:03 PM

Den Fehler bekomme ich auch bei jedem VDR Start. Glaub der ist "normal".

SurfaceCleanerZ · May 9, 2018 at 12:43 PM

Hi,

Teste doch den Treiber mal mit einem Live System mit aktuellem Kernel 4.16.

Z.B. Ubuntu 18.04 oder so.

Vdr Pakete hat Seahawk ja.

MfG Stefan

chrisz · September 19, 2018 at 11:38 AM

Quote from kls
Und prompt sehe ich natürlich, dass meine Ausgabe drei Zeilen weiter hinten reingehört hätte:
Code
for (int i = 0; i < MAXRECEIVERS; i++) {
                     cMutexLock MutexLock(&mutexReceiver);
                     cReceiver *Receiver = receiver[i];
                     if (Receiver && Receiver->WantsPid(Pid)) {
                        fprintf(stderr, " %d", i);//XXX
                        Receiver->Receive(b, TS_SIZE);
Ist aber egal, denn so wie es aussieht kommen überhaupt keine TS-Pakete an (kein "FOO-DBG [005] d").

Warum sich das in den beiden Fällen unterschiedlich verhält kann ich mir leider auch nicht erklären.

Klaus

Hallo Klaus, ich greife das Thema nochmal auf. Foo-DBG[005] d ist doch vorhanden in den logs...

[strace] 0kb 00001.ts

Participate now!

Users Viewing This Thread