jack: 8866:4635712605 engine.c:jack_process_external:729: reading byte from subgraph_wait_fd==13
jack: 8866:4635712623 ../jack/engine.h:jack_unlock_graph:188: releasing graph lock
jack: 8866:4635712630 engine.c:jack_run_one_cycle:2007: cycle finished, status = 0
jack: 8866:4635731407 ../jack/engine.h:jack_try_lock_graph:182: TRYING to acquiring graph lock
jack: 8866:4635731449 engine.c:jack_run_one_cycle:1956: waiting for driver read

jack: 8866:4635731461 engine.c:jack_run_one_cycle:1962: run process

jack: 8866:4635731468 engine.c:jack_engine_process:778: considering client alsa_pcm for processing
jack: 8866:4635731475 engine.c:jack_process_internal:567: invoking an internal client's callbacks
jack: 8866:4635731481 engine.c:jack_engine_process:778: considering client ardour for processing
jack: 8866:4635731486 engine.c:jack_process_external:646: calling process() on an external subgraph, fd==11
jack: 8866:4635731502 engine.c:jack_process_external:669: waiting on fd==13 for process() subgraph to finish
jack: 8863:4635731600 client.c:jack_client_thread:1292: pfd[EVENT].revents = 0x0 pfd[WAIT].revents = 0x1
jack: 8863:4635731628 client.c:jack_client_thread:1454: client 8863 signalled at 4635731486, awake for process at 4635731599 (delay = 113 usecs) (wakeup on graph_wait_fd==11)
jack: 8863:4635731647 client.c:jack_client_thread:1494: client finished processing at 4635731647 (elapsed = 48 usecs), writing on graph_next_fd==12
jack: 8863:4635731660 client.c:jack_client_thread:1507: client sent message to next stage by 4635731660, client reading on graph_wait_fd==11
jack: 8863:4635731667 client.c:jack_client_thread:1513: reading cleanup byte from pipe

jack: 8863:4635731677 client.c:jack_client_thread:1535: process cycle fully complete

jack: 8863:4635731683 client.c:jack_client_thread:1268: client polling on event_fd and graph_wait_fd...
jack: 8866:4635731716 engine.c:jack_process_external:677: 




 back from subgraph poll, revents = 0x1