Rclone vs acd_cli speeds

If you look at the logs, the dir listings isn’t what is taking time. The log starts at 10:07:33 and the first file open is also at 10:07:33. To me it looks like the pre-work that plex is doing to play the video. I assume playback was pressed at started around 10:07:33. It then opened and closed that file 3 times. You can then see it download in increasing sizes and forward to the end of the file and skip back to the beginning beginning to play… I’m assuming its doing some streaming test to see how fast it can stream to your client. Then it starts. That process take 9 seconds.

The question is still why that portion is slower on rclone than acdcli.

2016/11/09 10:07:33 Dir.Lookup
2016/11/09 10:07:33 Dir.Lookup OK
2016/11/09 10:07:33 File.Attr
2016/11/09 10:07:33 Dir.Lookup
2016/11/09 10:07:33 Dir.Lookup OK
2016/11/09 10:07:33 File.Attr
2016/11/09 10:07:33 Dir.Lookup
2016/11/09 10:07:33 Dir.Lookup OK

> directory look ups.

2016/11/09 10:07:33 : File.Open
2016/11/09 10:07:35 : ReadFileHandle.Release OK
2016/11/09 10:07:35 : File.Open
2016/11/09 10:07:37 : ReadFileHandle.Release OK
2016/11/09 10:07:37 : File.Open
2016/11/09 10:07:38 : ReadFileHandle.Read size 16384 offset 0
2016/11/09 10:07:38 : ReadFileHandle.Read size 32768 offset 16384
2016/11/09 10:07:38 : ReadFileHandle.Read size 65536 offset 49152
2016/11/09 10:07:39 : ReadFileHandle.Read size 131072 offset 114688
2016/11/09 10:07:39 : ReadFileHandle.Read size 131072 offset 245760
2016/11/09 10:07:39 : File.Attr
2016/11/09 10:07:39 : ReadFileHandle.Read size 4096 offset 314191872
2016/11/09 10:07:39 : ReadFileHandle.seek from 376832 to 314191872
2016/11/09 10:07:40 : File.Attr
2016/11/09 10:07:40 : ReadFileHandle.Read size 131072 offset 376832
2016/11/09 10:07:40 : ReadFileHandle.seek from 314195200 to 376832
2016/11/09 10:07:41 : ReadFileHandle.Read size 131072 offset 507904
2016/11/09 10:07:42 : File.Attr
2016/11/09 10:07:42 : ReadFileHandle.Read size 131072 offset 638976
> <<<<-- This looks like where playback actually starts.
2016/11/09 10:07:42 : ReadFileHandle.Read size 131072 offset 638976

… continued 20 times at the next offset of size 131072

2016/11/09 10:07:48 : ReadFileHandle.Read size 131072 offset 3260416
2016/11/09 10:07:48 : ReadFileHandle.Flush
2016/11/09 10:07:48 : ReadFileHandle.Flush OK
2016/11/09 10:07:48 : ReadFileHandle.Flush
2016/11/09 10:07:48 : ReadFileHandle.Flush OK
2016/11/09 10:07:48 : ReadFileHandle.Flush
2016/11/09 10:07:48 : ReadFileHandle.Flush OK
2016/11/09 10:07:48 : ReadFileHandle.Release closing
2016/11/09 10:07:48 : ReadFileHandle.Release OK
2016/11/09 10:08:01 : Dir.Attr