You are viewing a plain text version of this content. The canonical link for it is here.
Posted to user@mesos.apache.org by "DiGiorgio, Mr. Rinaldo S." <rd...@pace.edu> on 2016/06/03 20:11:33 UTC

OSX 10.10.5 and mesos 0.28.1 -- 10 to 20 X difference in sleep() method compared to non mesos

Hi,

	We are running the following Java application and we are getting unreasonable deltas in the actual amount time slept. On linux the results are as expected 10, 11, 12 but mostly 10ms.  Can you suggest any changes we can make or is this a known issue or a new issue to be investigated? When we run the same code on the same instance of OSX 10.10.5 without mesos  -- we get the expected results. 


public class SleepLatency {
   static final int COUNT = 100;
   static final long DELAY = 10L;

   public static void main(String[] args) throws Exception {
       long tstart = System.currentTimeMillis();
       for (int i = 0; i < COUNT; i++) {
           long t0 = System.currentTimeMillis();
           Thread.sleep(DELAY);
           long t1 = System.currentTimeMillis();
           System.out.printf("loop %3d delay %4d ms%n", i, t1 - t0);
       }
       long tfinish = System.currentTimeMillis();
       System.out.printf("total time = %5d ms%n", tfinish - tstart);
   }
}

====== OSX   RESULTS are 10 to 20 times  larger than LINUX Results below =====

sh -c '/opt/jdk/bin/java -cp ./mach5-mesos-support-1.0-SNAPSHOT.jar SleepLatency'
loop   0 delay  141 ms
loop   1 delay  201 ms
loop   2 delay   81 ms
loop   3 delay   14 ms
loop   4 delay  194 ms
loop   5 delay  149 ms
loop   6 delay  172 ms
loop   7 delay  203 ms
loop   8 delay  203 ms
loop   9 delay  204 ms
loop  10 delay  204 ms
loop  11 delay  204 ms
loop  12 delay  203 ms
loop  13 delay  203 ms
loop  14 delay   40 ms
loop  15 delay  206 ms
loop  16 delay  171 ms
loop  17 delay  107 ms
loop  18 delay   85 ms
loop  19 delay  204 ms
loop  20 delay  204 ms
loop  21 delay  203 ms
loop  22 delay  208 ms
loop  23 delay  200 ms
loop  24 delay  203 ms
loop  25 delay  203 ms
loop  26 delay  204 ms
loop  27 delay  204 ms
loop  28 delay  120 ms
loop  29 delay   83 ms
loop  30 delay  204 ms
loop  31 delay  203 ms
loop  32 delay  204 ms
loop  33 delay  208 ms
loop  34 delay  199 ms
loop  35 delay  204 ms
loop  36 delay  175 ms
loop  37 delay   11 ms
loop  38 delay  115 ms
loop  39 delay  205 ms
loop  40 delay  204 ms
loop  41 delay   11 ms
loop  42 delay   91 ms
loop  43 delay  202 ms
loop  44 delay  203 ms
loop  45 delay  204 ms
loop  46 delay  209 ms
loop  47 delay  112 ms
loop  48 delay   16 ms
loop  49 delay   69 ms
loop  50 delay  204 ms
loop  51 delay   18 ms
loop  52 delay   14 ms
loop  53 delay   70 ms
loop  54 delay   33 ms
loop  55 delay  184 ms
loop  56 delay  199 ms
loop  57 delay  194 ms
loop  58 delay  102 ms
loop  59 delay  102 ms
loop  60 delay   12 ms
loop  61 delay  197 ms
loop  62 delay  204 ms
loop  63 delay  204 ms
loop  64 delay  206 ms
loop  65 delay   11 ms
loop  66 delay  180 ms
loop  67 delay  202 ms
loop  68 delay   10 ms
loop  69 delay   20 ms
loop  70 delay  199 ms
loop  71 delay  179 ms
loop  72 delay  202 ms
loop  73 delay   33 ms
loop  74 delay   69 ms
loop  75 delay   14 ms
loop  76 delay   88 ms
loop  77 delay  204 ms
loop  78 delay  209 ms
loop  79 delay  198 ms
loop  80 delay  204 ms
loop  81 delay   25 ms
loop  82 delay   76 ms
loop  83 delay  102 ms
loop  84 delay  173 ms
loop  85 delay   13 ms
loop  86 delay   17 ms
loop  87 delay   14 ms
loop  88 delay  191 ms
loop  89 delay  204 ms
loop  90 delay  204 ms
loop  91 delay  102 ms
loop  92 delay   47 ms
loop  93 delay   37 ms
loop  94 delay  142 ms
loop  95 delay  202 ms
loop  96 delay  204 ms
loop  97 delay  202 ms
loop  98 delay  104 ms
loop  99 delay   80 ms
total time = 14193 ms


====== LINUX   RESULTS are as expected ======

sh -c '/opt/jdk/bin/java -cp ./mach5-mesos-support-1.0-SNAPSHOT.jar SleepLatency'
Forked command at 6125
loop   0 delay   10 ms
loop   1 delay   11 ms
loop   2 delay   10 ms
loop   3 delay   10 ms
loop   4 delay   10 ms
loop   5 delay   10 ms
loop   6 delay   10 ms
loop   7 delay   10 ms
loop   8 delay   10 ms
loop   9 delay   10 ms
loop  10 delay   10 ms
loop  11 delay   10 ms
loop  12 delay   10 ms
loop  13 delay   10 ms
loop  14 delay   10 ms
loop  15 delay   10 ms
loop  16 delay   10 ms
loop  17 delay   10 ms
loop  18 delay   10 ms
loop  19 delay   11 ms
loop  20 delay   10 ms
loop  21 delay   10 ms
loop  22 delay   10 ms
loop  23 delay   10 ms
loop  24 delay   10 ms
loop  25 delay   11 ms
loop  26 delay   10 ms
loop  27 delay   10 ms
loop  28 delay   10 ms
loop  29 delay   10 ms
loop  30 delay   10 ms
loop  31 delay   10 ms
loop  32 delay   10 ms
loop  33 delay   10 ms
loop  34 delay   11 ms
loop  35 delay   10 ms
loop  36 delay   10 ms
loop  37 delay   11 ms
loop  38 delay   10 ms
loop  39 delay   10 ms
loop  40 delay   11 ms
loop  41 delay   10 ms
loop  42 delay   10 ms
loop  43 delay   11 ms
loop  44 delay   10 ms
loop  45 delay   10 ms
loop  46 delay   10 ms
loop  47 delay   10 ms
loop  48 delay   10 ms
loop  49 delay   10 ms
loop  50 delay   10 ms
loop  51 delay   10 ms
loop  52 delay   11 ms
loop  53 delay   10 ms
loop  54 delay   10 ms
loop  55 delay   10 ms
loop  56 delay   10 ms
loop  57 delay   10 ms
loop  58 delay   10 ms
loop  59 delay   10 ms
loop  60 delay   10 ms
loop  61 delay   10 ms
loop  62 delay   11 ms
loop  63 delay   10 ms
loop  64 delay   10 ms
loop  65 delay   11 ms
loop  66 delay   10 ms
loop  67 delay   10 ms
loop  68 delay   10 ms
loop  69 delay   10 ms
loop  70 delay   10 ms
loop  71 delay   10 ms
loop  72 delay   11 ms
loop  73 delay   10 ms
loop  74 delay   10 ms
loop  75 delay   10 ms
loop  76 delay   11 ms
loop  77 delay   10 ms
loop  78 delay   10 ms
loop  79 delay   10 ms
loop  80 delay   11 ms
loop  81 delay   10 ms
loop  82 delay   10 ms
loop  83 delay   10 ms
loop  84 delay   10 ms
loop  85 delay   10 ms
loop  86 delay   10 ms
loop  87 delay   10 ms
loop  88 delay   10 ms
loop  89 delay   10 ms
loop  90 delay   10 ms
loop  91 delay   10 ms
loop  92 delay   10 ms
loop  93 delay   10 ms
loop  94 delay   10 ms
loop  95 delay   10 ms
loop  96 delay   10 ms
loop  97 delay   10 ms
loop  98 delay   10 ms
loop  99 delay   10 ms
total time =  1035 ms




Re: OSX 10.10.5 and mesos 0.28.1 -- 10 to 20 X difference in sleep() method compared to non mesos

Posted by James Mulcahy <ja...@apple.com>.
Hi Rinaldo,

MacOS X has a variety of mechanisms designed to improve energy efficiency, and many of these impact timer behavior.  I suspect that this is what is affecting you.   There is a whitepaper here, which has more details https://www.apple.com/media/us/osx/2013/docs/OSX_Power_Efficiency_Technology_Overview.pdf

—James

> On Jun 3, 2016, at 13:11, DiGiorgio, Mr. Rinaldo S. <rd...@pace.edu> wrote:
> 
> Hi,
> 
> 	We are running the following Java application and we are getting unreasonable deltas in the actual amount time slept. On linux the results are as expected 10, 11, 12 but mostly 10ms.  Can you suggest any changes we can make or is this a known issue or a new issue to be investigated? When we run the same code on the same instance of OSX 10.10.5 without mesos  -- we get the expected results. 
> 
> 
> public class SleepLatency {
>   static final int COUNT = 100;
>   static final long DELAY = 10L;
> 
>   public static void main(String[] args) throws Exception {
>       long tstart = System.currentTimeMillis();
>       for (int i = 0; i < COUNT; i++) {
>           long t0 = System.currentTimeMillis();
>           Thread.sleep(DELAY);
>           long t1 = System.currentTimeMillis();
>           System.out.printf("loop %3d delay %4d ms%n", i, t1 - t0);
>       }
>       long tfinish = System.currentTimeMillis();
>       System.out.printf("total time = %5d ms%n", tfinish - tstart);
>   }
> }
> 
> ====== OSX   RESULTS are 10 to 20 times  larger than LINUX Results below =====
> 
> sh -c '/opt/jdk/bin/java -cp ./mach5-mesos-support-1.0-SNAPSHOT.jar SleepLatency'
> loop   0 delay  141 ms
> loop   1 delay  201 ms
> loop   2 delay   81 ms
> loop   3 delay   14 ms
> loop   4 delay  194 ms
> loop   5 delay  149 ms
> loop   6 delay  172 ms
> loop   7 delay  203 ms
> loop   8 delay  203 ms
> loop   9 delay  204 ms
> loop  10 delay  204 ms
> loop  11 delay  204 ms
> loop  12 delay  203 ms
> loop  13 delay  203 ms
> loop  14 delay   40 ms
> loop  15 delay  206 ms
> loop  16 delay  171 ms
> loop  17 delay  107 ms
> loop  18 delay   85 ms
> loop  19 delay  204 ms
> loop  20 delay  204 ms
> loop  21 delay  203 ms
> loop  22 delay  208 ms
> loop  23 delay  200 ms
> loop  24 delay  203 ms
> loop  25 delay  203 ms
> loop  26 delay  204 ms
> loop  27 delay  204 ms
> loop  28 delay  120 ms
> loop  29 delay   83 ms
> loop  30 delay  204 ms
> loop  31 delay  203 ms
> loop  32 delay  204 ms
> loop  33 delay  208 ms
> loop  34 delay  199 ms
> loop  35 delay  204 ms
> loop  36 delay  175 ms
> loop  37 delay   11 ms
> loop  38 delay  115 ms
> loop  39 delay  205 ms
> loop  40 delay  204 ms
> loop  41 delay   11 ms
> loop  42 delay   91 ms
> loop  43 delay  202 ms
> loop  44 delay  203 ms
> loop  45 delay  204 ms
> loop  46 delay  209 ms
> loop  47 delay  112 ms
> loop  48 delay   16 ms
> loop  49 delay   69 ms
> loop  50 delay  204 ms
> loop  51 delay   18 ms
> loop  52 delay   14 ms
> loop  53 delay   70 ms
> loop  54 delay   33 ms
> loop  55 delay  184 ms
> loop  56 delay  199 ms
> loop  57 delay  194 ms
> loop  58 delay  102 ms
> loop  59 delay  102 ms
> loop  60 delay   12 ms
> loop  61 delay  197 ms
> loop  62 delay  204 ms
> loop  63 delay  204 ms
> loop  64 delay  206 ms
> loop  65 delay   11 ms
> loop  66 delay  180 ms
> loop  67 delay  202 ms
> loop  68 delay   10 ms
> loop  69 delay   20 ms
> loop  70 delay  199 ms
> loop  71 delay  179 ms
> loop  72 delay  202 ms
> loop  73 delay   33 ms
> loop  74 delay   69 ms
> loop  75 delay   14 ms
> loop  76 delay   88 ms
> loop  77 delay  204 ms
> loop  78 delay  209 ms
> loop  79 delay  198 ms
> loop  80 delay  204 ms
> loop  81 delay   25 ms
> loop  82 delay   76 ms
> loop  83 delay  102 ms
> loop  84 delay  173 ms
> loop  85 delay   13 ms
> loop  86 delay   17 ms
> loop  87 delay   14 ms
> loop  88 delay  191 ms
> loop  89 delay  204 ms
> loop  90 delay  204 ms
> loop  91 delay  102 ms
> loop  92 delay   47 ms
> loop  93 delay   37 ms
> loop  94 delay  142 ms
> loop  95 delay  202 ms
> loop  96 delay  204 ms
> loop  97 delay  202 ms
> loop  98 delay  104 ms
> loop  99 delay   80 ms
> total time = 14193 ms
> 
> 
> ====== LINUX   RESULTS are as expected ======
> 
> sh -c '/opt/jdk/bin/java -cp ./mach5-mesos-support-1.0-SNAPSHOT.jar SleepLatency'
> Forked command at 6125
> loop   0 delay   10 ms
> loop   1 delay   11 ms
> loop   2 delay   10 ms
> loop   3 delay   10 ms
> loop   4 delay   10 ms
> loop   5 delay   10 ms
> loop   6 delay   10 ms
> loop   7 delay   10 ms
> loop   8 delay   10 ms
> loop   9 delay   10 ms
> loop  10 delay   10 ms
> loop  11 delay   10 ms
> loop  12 delay   10 ms
> loop  13 delay   10 ms
> loop  14 delay   10 ms
> loop  15 delay   10 ms
> loop  16 delay   10 ms
> loop  17 delay   10 ms
> loop  18 delay   10 ms
> loop  19 delay   11 ms
> loop  20 delay   10 ms
> loop  21 delay   10 ms
> loop  22 delay   10 ms
> loop  23 delay   10 ms
> loop  24 delay   10 ms
> loop  25 delay   11 ms
> loop  26 delay   10 ms
> loop  27 delay   10 ms
> loop  28 delay   10 ms
> loop  29 delay   10 ms
> loop  30 delay   10 ms
> loop  31 delay   10 ms
> loop  32 delay   10 ms
> loop  33 delay   10 ms
> loop  34 delay   11 ms
> loop  35 delay   10 ms
> loop  36 delay   10 ms
> loop  37 delay   11 ms
> loop  38 delay   10 ms
> loop  39 delay   10 ms
> loop  40 delay   11 ms
> loop  41 delay   10 ms
> loop  42 delay   10 ms
> loop  43 delay   11 ms
> loop  44 delay   10 ms
> loop  45 delay   10 ms
> loop  46 delay   10 ms
> loop  47 delay   10 ms
> loop  48 delay   10 ms
> loop  49 delay   10 ms
> loop  50 delay   10 ms
> loop  51 delay   10 ms
> loop  52 delay   11 ms
> loop  53 delay   10 ms
> loop  54 delay   10 ms
> loop  55 delay   10 ms
> loop  56 delay   10 ms
> loop  57 delay   10 ms
> loop  58 delay   10 ms
> loop  59 delay   10 ms
> loop  60 delay   10 ms
> loop  61 delay   10 ms
> loop  62 delay   11 ms
> loop  63 delay   10 ms
> loop  64 delay   10 ms
> loop  65 delay   11 ms
> loop  66 delay   10 ms
> loop  67 delay   10 ms
> loop  68 delay   10 ms
> loop  69 delay   10 ms
> loop  70 delay   10 ms
> loop  71 delay   10 ms
> loop  72 delay   11 ms
> loop  73 delay   10 ms
> loop  74 delay   10 ms
> loop  75 delay   10 ms
> loop  76 delay   11 ms
> loop  77 delay   10 ms
> loop  78 delay   10 ms
> loop  79 delay   10 ms
> loop  80 delay   11 ms
> loop  81 delay   10 ms
> loop  82 delay   10 ms
> loop  83 delay   10 ms
> loop  84 delay   10 ms
> loop  85 delay   10 ms
> loop  86 delay   10 ms
> loop  87 delay   10 ms
> loop  88 delay   10 ms
> loop  89 delay   10 ms
> loop  90 delay   10 ms
> loop  91 delay   10 ms
> loop  92 delay   10 ms
> loop  93 delay   10 ms
> loop  94 delay   10 ms
> loop  95 delay   10 ms
> loop  96 delay   10 ms
> loop  97 delay   10 ms
> loop  98 delay   10 ms
> loop  99 delay   10 ms
> total time =  1035 ms
> 
> 
> 


Re: OSX 10.10.5 and mesos 0.28.1 -- 10 to 20 X difference in sleep() method compared to non mesos

Posted by Rinaldo Digiorgio <rd...@pace.edu>.
I performed the following tests

	Built the latest tip 1.0 on OS X 10.11.4,  2.3 GHz Intel Core i7 with 16GB and load average of 1+ I ran the test program, SleepLatency.java  with Java 1.8 and 1.7 and I am getting very poor results. I am unable to reproduce the results reported by haosdent .  I have also increased the priority of the mesos agent and mesos master.  Is there something I am missing here in the config.

	I have the master and the agent running on the same machine.

	Not using zookeeper

	Using localhost

	No special options for the master and the agent

		0 894 1 0 2:15PM ?? 0:29.22 /usr/local/sbin/mesos-master --work_dir=/scratch/mesos/master --ip=127.0.0.1 
                0 896 1 0 2:15PM ?? 1:15.55 /usr/local/sbin/mesos-slave --master=127.0.0.1:5050 --work_dir=/scratch/mesos/slave

	Turned off power nap


Rinaldo


This is the application


 public class SleepLatency {
    static final int COUNT = 100;
    static final long DELAY = 10L;

    public static void main(String[] args) throws Exception {
        long tstart = System.currentTimeMillis();
        for (int i = 0; i < COUNT; i++) {
            long t0 = System.currentTimeMillis();
            Thread.sleep(DELAY);
            long t1 = System.currentTimeMillis();
            System.out.printf("loop %3d delay %4d ms%n", i, t1 - t0);
        }
        long tfinish = System.currentTimeMillis();
        System.out.printf("total time = %5d ms%n", tfinish - tstart);
    }
 }

and how it was launched

mesos-execute --master="127.0.0.1:5050" --name="SleepLatency" --command="cd /tmp && java SleepLatency”


Rinaldo

> On Jun 6, 2016, at 11:28 AM, haosdent <ha...@gmail.com> wrote:
> 
> yes, mine is a laptop.
> 
> On Mon, Jun 6, 2016 at 11:23 PM, DiGiorgio, Mr. Rinaldo S. <rd...@pace.edu> wrote:
> 
>> On Jun 6, 2016, at 11:08, haosdent <ha...@gmail.com> wrote:
>> 
>> I use OS X 10.11.4 but I think it should not related to this minor different on OS X version.
>> For settings, I disable `Enable Power Nap while plugged into a power adapter` in `Energy Saver`.
> 
> I assume you have a laptop, I have retested with power nap being set to off on an iMac and it did not make a difference. I will try it on a laptop.  The other 15 Macs are all towers. Maybe it is a clue, works on laptops but not on desktops.
>> On Mon, Jun 6, 2016 at 10:57 PM, DiGiorgio, Mr. Rinaldo S. <rd...@pace.edu> wrote:
> 
> 
>> Thanks James and Haosdent,
>> 
>> I built my own version of mesos 1.0 and installed it on 10.11.5 and I am getting the same results as 10.10.5 with 0.28.1
>> 
>> Do either of you remember what you may have set on your OSX machines to default some of the desktop settings that may be causing this issue?
>> 
>> 
>> We are already turning off many desktop features since they are not relevant for our use case.
>> 
>> 
>> 
>> Received SUBSCRIBED event
>> Subscribed executor on dhcp-adc-twvpn-3-vpnpool-10-154-101-79.vpn.oracle.com
>> Received LAUNCH event
>> Starting task test-sleep
>> sh -c 'cd /tmp && java SleepLatency'
>> Forked command at 2907
>> loop   0 delay   35 ms
>> loop   1 delay  108 ms
>> loop   2 delay  104 ms
>> loop   3 delay   57 ms
>> loop   4 delay  104 ms
>> loop   5 delay   93 ms
>> loop   6 delay   12 ms
>> loop   7 delay   17 ms
>> loop   8 delay  105 ms
>> loop   9 delay  109 ms
>> 
>> 
>> > On Jun 4, 2016, at 05:07, haosdent <ha...@gmail.com> wrote:
>> >
>> > Hi, Rinaldo. I test your problem in my local Mesos (run in my mac). It looks normal in my side. I started it by
>> >
>> > ```
>> > mesos-execute --master="localhost:5050" --name="test-sleep" --command="cd /tmp && java SleepLatency"
>> > ```
>> >
>> > ```
>> > Registered executor on localhost
>> > Starting task test-sleep
>> > sh -c 'cd /tmp && java SleepLatency'
>> > Forked command at 42480
>> > loop   0 delay   11 ms
>> > loop   1 delay   12 ms
>> > loop   2 delay   11 ms
>> > loop   3 delay   13 ms
>> > loop   4 delay   12 ms
>> > loop   5 delay   12 ms
>> > loop   6 delay   12 ms
>> > loop   7 delay   12 ms
>> > loop   8 delay   12 ms
>> > loop   9 delay   11 ms
>> > loop  10 delay   12 ms
>> > loop  11 delay   13 ms
>> > loop  12 delay   11 ms
>> > loop  13 delay   11 ms
>> > loop  14 delay   12 ms
>> > loop  15 delay   12 ms
>> > loop  16 delay   13 ms
>> > loop  17 delay   12 ms
>> > loop  18 delay   11 ms
>> > loop  19 delay   12 ms
>> > loop  20 delay   12 ms
>> > loop  21 delay   11 ms
>> > loop  22 delay   12 ms
>> > loop  23 delay   11 ms
>> > loop  24 delay   12 ms
>> > loop  25 delay   12 ms
>> > loop  26 delay   12 ms
>> > loop  27 delay   12 ms
>> > loop  28 delay   13 ms
>> > loop  29 delay   12 ms
>> > loop  30 delay   12 ms
>> > loop  31 delay   11 ms
>> > loop  32 delay   11 ms
>> > loop  33 delay   11 ms
>> > loop  34 delay   13 ms
>> > loop  35 delay   10 ms
>> > loop  36 delay   12 ms
>> > loop  37 delay   11 ms
>> > loop  38 delay   12 ms
>> > loop  39 delay   12 ms
>> > loop  40 delay   12 ms
>> > loop  41 delay   12 ms
>> > loop  42 delay   12 ms
>> > loop  43 delay   11 ms
>> > loop  44 delay   12 ms
>> > loop  45 delay   12 ms
>> > loop  46 delay   12 ms
>> > loop  47 delay   12 ms
>> > loop  48 delay   12 ms
>> > loop  49 delay   12 ms
>> > loop  50 delay   12 ms
>> > loop  51 delay   12 ms
>> > loop  52 delay   12 ms
>> > loop  53 delay   13 ms
>> > loop  54 delay   11 ms
>> > loop  55 delay   12 ms
>> > loop  56 delay   12 ms
>> > loop  57 delay   12 ms
>> > loop  58 delay   12 ms
>> > loop  59 delay   11 ms
>> > loop  60 delay   11 ms
>> > loop  61 delay   11 ms
>> > loop  62 delay   11 ms
>> > loop  63 delay   12 ms
>> > loop  64 delay   12 ms
>> > loop  65 delay   12 ms
>> > loop  66 delay   12 ms
>> > loop  67 delay   12 ms
>> > loop  68 delay   11 ms
>> > loop  69 delay   13 ms
>> > loop  70 delay   12 ms
>> > loop  71 delay   10 ms
>> > loop  72 delay   12 ms
>> > loop  73 delay   10 ms
>> > loop  74 delay   11 ms
>> > loop  75 delay   12 ms
>> > loop  76 delay   10 ms
>> > loop  77 delay   11 ms
>> > loop  78 delay   12 ms
>> > loop  79 delay   10 ms
>> > loop  80 delay   12 ms
>> > loop  81 delay   12 ms
>> > loop  82 delay   11 ms
>> > loop  83 delay   11 ms
>> > loop  84 delay   12 ms
>> > loop  85 delay   11 ms
>> > loop  86 delay   12 ms
>> > loop  87 delay   12 ms
>> > loop  88 delay   12 ms
>> > loop  89 delay   11 ms
>> > loop  90 delay   12 ms
>> > loop  91 delay   12 ms
>> > loop  92 delay   13 ms
>> > loop  93 delay   12 ms
>> > loop  94 delay   11 ms
>> > loop  95 delay   10 ms
>> > loop  96 delay   12 ms
>> > loop  97 delay   11 ms
>> > loop  98 delay   12 ms
>> > loop  99 delay   12 ms
>> > total time =  1215 ms
>> > Command exited with status 0 (pid: 42480)
>> > ```
>> >
>> > On Sat, Jun 4, 2016 at 4:11 AM, DiGiorgio, Mr. Rinaldo S. <rd...@pace.edu> wrote:
>> > Hi,
>> >
>> >         We are running the following Java application and we are getting unreasonable deltas in the actual amount time slept. On linux the results are as expected 10, 11, 12 but mostly 10ms.  Can you suggest any changes we can make or is this a known issue or a new issue to be investigated? When we run the same code on the same instance of OSX 10.10.5 without mesos  -- we get the expected results.
>> >
>> >
>> > public class SleepLatency {
>> >    static final int COUNT = 100;
>> >    static final long DELAY = 10L;
>> >
>> >    public static void main(String[] args) throws Exception {
>> >        long tstart = System.currentTimeMillis();
>> >        for (int i = 0; i < COUNT; i++) {
>> >            long t0 = System.currentTimeMillis();
>> >            Thread.sleep(DELAY);
>> >            long t1 = System.currentTimeMillis();
>> >            System.out.printf("loop %3d delay %4d ms%n", i, t1 - t0);
>> >        }
>> >        long tfinish = System.currentTimeMillis();
>> >        System.out.printf("total time = %5d ms%n", tfinish - tstart);
>> >    }
>> > }
>> >
>> > ====== OSX   RESULTS are 10 to 20 times  larger than LINUX Results below =====
>> >
>> > sh -c '/opt/jdk/bin/java -cp ./mach5-mesos-support-1.0-SNAPSHOT.jar SleepLatency'
>> > loop   0 delay  141 ms
>> > loop   1 delay  201 ms
>> > loop   2 delay   81 ms
>> > loop   3 delay   14 ms
>> > loop   4 delay  194 ms
>> > loop   5 delay  149 ms
>> > loop   6 delay  172 ms
>> > loop   7 delay  203 ms
>> > loop   8 delay  203 ms
>> > loop   9 delay  204 ms
>> > loop  10 delay  204 ms
>> > loop  11 delay  204 ms
>> > loop  12 delay  203 ms
>> > loop  13 delay  203 ms
>> > loop  14 delay   40 ms
>> > loop  15 delay  206 ms
>> > loop  16 delay  171 ms
>> > loop  17 delay  107 ms
>> > loop  18 delay   85 ms
>> > loop  19 delay  204 ms
>> > loop  20 delay  204 ms
>> > loop  21 delay  203 ms
>> > loop  22 delay  208 ms
>> > loop  23 delay  200 ms
>> > loop  24 delay  203 ms
>> > loop  25 delay  203 ms
>> > loop  26 delay  204 ms
>> > loop  27 delay  204 ms
>> > loop  28 delay  120 ms
>> > loop  29 delay   83 ms
>> > loop  30 delay  204 ms
>> > loop  31 delay  203 ms
>> > loop  32 delay  204 ms
>> > loop  33 delay  208 ms
>> > loop  34 delay  199 ms
>> > loop  35 delay  204 ms
>> > loop  36 delay  175 ms
>> > loop  37 delay   11 ms
>> > loop  38 delay  115 ms
>> > loop  39 delay  205 ms
>> > loop  40 delay  204 ms
>> > loop  41 delay   11 ms
>> > loop  42 delay   91 ms
>> > loop  43 delay  202 ms
>> > loop  44 delay  203 ms
>> > loop  45 delay  204 ms
>> > loop  46 delay  209 ms
>> > loop  47 delay  112 ms
>> > loop  48 delay   16 ms
>> > loop  49 delay   69 ms
>> > loop  50 delay  204 ms
>> > loop  51 delay   18 ms
>> > loop  52 delay   14 ms
>> > loop  53 delay   70 ms
>> > loop  54 delay   33 ms
>> > loop  55 delay  184 ms
>> > loop  56 delay  199 ms
>> > loop  57 delay  194 ms
>> > loop  58 delay  102 ms
>> > loop  59 delay  102 ms
>> > loop  60 delay   12 ms
>> > loop  61 delay  197 ms
>> > loop  62 delay  204 ms
>> > loop  63 delay  204 ms
>> > loop  64 delay  206 ms
>> > loop  65 delay   11 ms
>> > loop  66 delay  180 ms
>> > loop  67 delay  202 ms
>> > loop  68 delay   10 ms
>> > loop  69 delay   20 ms
>> > loop  70 delay  199 ms
>> > loop  71 delay  179 ms
>> > loop  72 delay  202 ms
>> > loop  73 delay   33 ms
>> > loop  74 delay   69 ms
>> > loop  75 delay   14 ms
>> > loop  76 delay   88 ms
>> > loop  77 delay  204 ms
>> > loop  78 delay  209 ms
>> > loop  79 delay  198 ms
>> > loop  80 delay  204 ms
>> > loop  81 delay   25 ms
>> > loop  82 delay   76 ms
>> > loop  83 delay  102 ms
>> > loop  84 delay  173 ms
>> > loop  85 delay   13 ms
>> > loop  86 delay   17 ms
>> > loop  87 delay   14 ms
>> > loop  88 delay  191 ms
>> > loop  89 delay  204 ms
>> > loop  90 delay  204 ms
>> > loop  91 delay  102 ms
>> > loop  92 delay   47 ms
>> > loop  93 delay   37 ms
>> > loop  94 delay  142 ms
>> > loop  95 delay  202 ms
>> > loop  96 delay  204 ms
>> > loop  97 delay  202 ms
>> > loop  98 delay  104 ms
>> > loop  99 delay   80 ms
>> > total time = 14193 ms
>> >
>> >
>> > ====== LINUX   RESULTS are as expected ======
>> >
>> > sh -c '/opt/jdk/bin/java -cp ./mach5-mesos-support-1.0-SNAPSHOT.jar SleepLatency'
>> > Forked command at 6125
>> > loop   0 delay   10 ms
>> > loop   1 delay   11 ms
>> > loop   2 delay   10 ms
>> > loop   3 delay   10 ms
>> > loop   4 delay   10 ms
>> > loop   5 delay   10 ms
>> > loop   6 delay   10 ms
>> > loop   7 delay   10 ms
>> > loop   8 delay   10 ms
>> > loop   9 delay   10 ms
>> > loop  10 delay   10 ms
>> > loop  11 delay   10 ms
>> > loop  12 delay   10 ms
>> > loop  13 delay   10 ms
>> > loop  14 delay   10 ms
>> > loop  15 delay   10 ms
>> > loop  16 delay   10 ms
>> > loop  17 delay   10 ms
>> > loop  18 delay   10 ms
>> > loop  19 delay   11 ms
>> > loop  20 delay   10 ms
>> > loop  21 delay   10 ms
>> > loop  22 delay   10 ms
>> > loop  23 delay   10 ms
>> > loop  24 delay   10 ms
>> > loop  25 delay   11 ms
>> > loop  26 delay   10 ms
>> > loop  27 delay   10 ms
>> > loop  28 delay   10 ms
>> > loop  29 delay   10 ms
>> > loop  30 delay   10 ms
>> > loop  31 delay   10 ms
>> > loop  32 delay   10 ms
>> > loop  33 delay   10 ms
>> > loop  34 delay   11 ms
>> > loop  35 delay   10 ms
>> > loop  36 delay   10 ms
>> > loop  37 delay   11 ms
>> > loop  38 delay   10 ms
>> > loop  39 delay   10 ms
>> > loop  40 delay   11 ms
>> > loop  41 delay   10 ms
>> > loop  42 delay   10 ms
>> > loop  43 delay   11 ms
>> > loop  44 delay   10 ms
>> > loop  45 delay   10 ms
>> > loop  46 delay   10 ms
>> > loop  47 delay   10 ms
>> > loop  48 delay   10 ms
>> > loop  49 delay   10 ms
>> > loop  50 delay   10 ms
>> > loop  51 delay   10 ms
>> > loop  52 delay   11 ms
>> > loop  53 delay   10 ms
>> > loop  54 delay   10 ms
>> > loop  55 delay   10 ms
>> > loop  56 delay   10 ms
>> > loop  57 delay   10 ms
>> > loop  58 delay   10 ms
>> > loop  59 delay   10 ms
>> > loop  60 delay   10 ms
>> > loop  61 delay   10 ms
>> > loop  62 delay   11 ms
>> > loop  63 delay   10 ms
>> > loop  64 delay   10 ms
>> > loop  65 delay   11 ms
>> > loop  66 delay   10 ms
>> > loop  67 delay   10 ms
>> > loop  68 delay   10 ms
>> > loop  69 delay   10 ms
>> > loop  70 delay   10 ms
>> > loop  71 delay   10 ms
>> > loop  72 delay   11 ms
>> > loop  73 delay   10 ms
>> > loop  74 delay   10 ms
>> > loop  75 delay   10 ms
>> > loop  76 delay   11 ms
>> > loop  77 delay   10 ms
>> > loop  78 delay   10 ms
>> > loop  79 delay   10 ms
>> > loop  80 delay   11 ms
>> > loop  81 delay   10 ms
>> > loop  82 delay   10 ms
>> > loop  83 delay   10 ms
>> > loop  84 delay   10 ms
>> > loop  85 delay   10 ms
>> > loop  86 delay   10 ms
>> > loop  87 delay   10 ms
>> > loop  88 delay   10 ms
>> > loop  89 delay   10 ms
>> > loop  90 delay   10 ms
>> > loop  91 delay   10 ms
>> > loop  92 delay   10 ms
>> > loop  93 delay   10 ms
>> > loop  94 delay   10 ms
>> > loop  95 delay   10 ms
>> > loop  96 delay   10 ms
>> > loop  97 delay   10 ms
>> > loop  98 delay   10 ms
>> > loop  99 delay   10 ms
>> > total time =  1035 ms
>> >
>> >
>> >
>> >
>> >
>> >
>> > --
>> > Best Regards,
>> > Haosdent Huang
>> 
>> 
>> 
>> 
>> -- 
>> Best Regards,
>> Haosdent Huang
> 
> 
> 
> 
> -- 
> Best Regards,
> Haosdent Huang


Re: OSX 10.10.5 and mesos 0.28.1 -- 10 to 20 X difference in sleep() method compared to non mesos

Posted by haosdent <ha...@gmail.com>.
yes, mine is a laptop.

On Mon, Jun 6, 2016 at 11:23 PM, DiGiorgio, Mr. Rinaldo S. <
rdigiorgio@pace.edu> wrote:

>
> On Jun 6, 2016, at 11:08, haosdent <ha...@gmail.com> wrote:
>
> I use OS X 10.11.4 but I think it should not related to this minor
> different on OS X version.
> For settings, I disable `Enable Power Nap while plugged into a power
> adapter` in `Energy Saver`.
>
>
> I assume you have a laptop, I have retested with power nap being set to
> off on an iMac and it did not make a difference. I will try it on a
> laptop.  The other 15 Macs are all towers. Maybe it is a clue, works on
> laptops but not on desktops.
>
> On Mon, Jun 6, 2016 at 10:57 PM, DiGiorgio, Mr. Rinaldo S. <
> rdigiorgio@pace.edu> wrote:
>
>
>
> Thanks James and Haosdent,
>>
>> I built my own version of mesos 1.0 and installed it on 10.11.5 and I am
>> getting the same results as 10.10.5 with 0.28.1
>>
>> Do either of you remember what you may have set on your OSX machines to
>> default some of the desktop settings that may be causing this issue?
>>
>>
>> We are already turning off many desktop features since they are not
>> relevant for our use case.
>>
>>
>>
>> Received SUBSCRIBED event
>> Subscribed executor on
>> dhcp-adc-twvpn-3-vpnpool-10-154-101-79.vpn.oracle.com
>> Received LAUNCH event
>> Starting task test-sleep
>> sh -c 'cd /tmp && java SleepLatency'
>> Forked command at 2907
>> loop   0 delay   35 ms
>> loop   1 delay  108 ms
>> loop   2 delay  104 ms
>> loop   3 delay   57 ms
>> loop   4 delay  104 ms
>> loop   5 delay   93 ms
>> loop   6 delay   12 ms
>> loop   7 delay   17 ms
>> loop   8 delay  105 ms
>> loop   9 delay  109 ms
>>
>>
>> > On Jun 4, 2016, at 05:07, haosdent <ha...@gmail.com> wrote:
>> >
>> > Hi, Rinaldo. I test your problem in my local Mesos (run in my mac). It
>> looks normal in my side. I started it by
>> >
>> > ```
>> > mesos-execute --master="localhost:5050" --name="test-sleep"
>> --command="cd /tmp && java SleepLatency"
>> > ```
>> >
>> > ```
>> > Registered executor on localhost
>> > Starting task test-sleep
>> > sh -c 'cd /tmp && java SleepLatency'
>> > Forked command at 42480
>> > loop   0 delay   11 ms
>> > loop   1 delay   12 ms
>> > loop   2 delay   11 ms
>> > loop   3 delay   13 ms
>> > loop   4 delay   12 ms
>> > loop   5 delay   12 ms
>> > loop   6 delay   12 ms
>> > loop   7 delay   12 ms
>> > loop   8 delay   12 ms
>> > loop   9 delay   11 ms
>> > loop  10 delay   12 ms
>> > loop  11 delay   13 ms
>> > loop  12 delay   11 ms
>> > loop  13 delay   11 ms
>> > loop  14 delay   12 ms
>> > loop  15 delay   12 ms
>> > loop  16 delay   13 ms
>> > loop  17 delay   12 ms
>> > loop  18 delay   11 ms
>> > loop  19 delay   12 ms
>> > loop  20 delay   12 ms
>> > loop  21 delay   11 ms
>> > loop  22 delay   12 ms
>> > loop  23 delay   11 ms
>> > loop  24 delay   12 ms
>> > loop  25 delay   12 ms
>> > loop  26 delay   12 ms
>> > loop  27 delay   12 ms
>> > loop  28 delay   13 ms
>> > loop  29 delay   12 ms
>> > loop  30 delay   12 ms
>> > loop  31 delay   11 ms
>> > loop  32 delay   11 ms
>> > loop  33 delay   11 ms
>> > loop  34 delay   13 ms
>> > loop  35 delay   10 ms
>> > loop  36 delay   12 ms
>> > loop  37 delay   11 ms
>> > loop  38 delay   12 ms
>> > loop  39 delay   12 ms
>> > loop  40 delay   12 ms
>> > loop  41 delay   12 ms
>> > loop  42 delay   12 ms
>> > loop  43 delay   11 ms
>> > loop  44 delay   12 ms
>> > loop  45 delay   12 ms
>> > loop  46 delay   12 ms
>> > loop  47 delay   12 ms
>> > loop  48 delay   12 ms
>> > loop  49 delay   12 ms
>> > loop  50 delay   12 ms
>> > loop  51 delay   12 ms
>> > loop  52 delay   12 ms
>> > loop  53 delay   13 ms
>> > loop  54 delay   11 ms
>> > loop  55 delay   12 ms
>> > loop  56 delay   12 ms
>> > loop  57 delay   12 ms
>> > loop  58 delay   12 ms
>> > loop  59 delay   11 ms
>> > loop  60 delay   11 ms
>> > loop  61 delay   11 ms
>> > loop  62 delay   11 ms
>> > loop  63 delay   12 ms
>> > loop  64 delay   12 ms
>> > loop  65 delay   12 ms
>> > loop  66 delay   12 ms
>> > loop  67 delay   12 ms
>> > loop  68 delay   11 ms
>> > loop  69 delay   13 ms
>> > loop  70 delay   12 ms
>> > loop  71 delay   10 ms
>> > loop  72 delay   12 ms
>> > loop  73 delay   10 ms
>> > loop  74 delay   11 ms
>> > loop  75 delay   12 ms
>> > loop  76 delay   10 ms
>> > loop  77 delay   11 ms
>> > loop  78 delay   12 ms
>> > loop  79 delay   10 ms
>> > loop  80 delay   12 ms
>> > loop  81 delay   12 ms
>> > loop  82 delay   11 ms
>> > loop  83 delay   11 ms
>> > loop  84 delay   12 ms
>> > loop  85 delay   11 ms
>> > loop  86 delay   12 ms
>> > loop  87 delay   12 ms
>> > loop  88 delay   12 ms
>> > loop  89 delay   11 ms
>> > loop  90 delay   12 ms
>> > loop  91 delay   12 ms
>> > loop  92 delay   13 ms
>> > loop  93 delay   12 ms
>> > loop  94 delay   11 ms
>> > loop  95 delay   10 ms
>> > loop  96 delay   12 ms
>> > loop  97 delay   11 ms
>> > loop  98 delay   12 ms
>> > loop  99 delay   12 ms
>> > total time =  1215 ms
>> > Command exited with status 0 (pid: 42480)
>> > ```
>> >
>> > On Sat, Jun 4, 2016 at 4:11 AM, DiGiorgio, Mr. Rinaldo S. <
>> rdigiorgio@pace.edu> wrote:
>> > Hi,
>> >
>> >         We are running the following Java application and we are
>> getting unreasonable deltas in the actual amount time slept. On linux the
>> results are as expected 10, 11, 12 but mostly 10ms.  Can you suggest any
>> changes we can make or is this a known issue or a new issue to be
>> investigated? When we run the same code on the same instance of OSX 10.10.5
>> without mesos  -- we get the expected results.
>> >
>> >
>> > public class SleepLatency {
>> >    static final int COUNT = 100;
>> >    static final long DELAY = 10L;
>> >
>> >    public static void main(String[] args) throws Exception {
>> >        long tstart = System.currentTimeMillis();
>> >        for (int i = 0; i < COUNT; i++) {
>> >            long t0 = System.currentTimeMillis();
>> >            Thread.sleep(DELAY);
>> >            long t1 = System.currentTimeMillis();
>> >            System.out.printf("loop %3d delay %4d ms%n", i, t1 - t0);
>> >        }
>> >        long tfinish = System.currentTimeMillis();
>> >        System.out.printf("total time = %5d ms%n", tfinish - tstart);
>> >    }
>> > }
>> >
>> > ====== OSX   RESULTS are 10 to 20 times  larger than LINUX Results
>> below =====
>> >
>> > sh -c '/opt/jdk/bin/java -cp ./mach5-mesos-support-1.0-SNAPSHOT.jar
>> SleepLatency'
>> > loop   0 delay  141 ms
>> > loop   1 delay  201 ms
>> > loop   2 delay   81 ms
>> > loop   3 delay   14 ms
>> > loop   4 delay  194 ms
>> > loop   5 delay  149 ms
>> > loop   6 delay  172 ms
>> > loop   7 delay  203 ms
>> > loop   8 delay  203 ms
>> > loop   9 delay  204 ms
>> > loop  10 delay  204 ms
>> > loop  11 delay  204 ms
>> > loop  12 delay  203 ms
>> > loop  13 delay  203 ms
>> > loop  14 delay   40 ms
>> > loop  15 delay  206 ms
>> > loop  16 delay  171 ms
>> > loop  17 delay  107 ms
>> > loop  18 delay   85 ms
>> > loop  19 delay  204 ms
>> > loop  20 delay  204 ms
>> > loop  21 delay  203 ms
>> > loop  22 delay  208 ms
>> > loop  23 delay  200 ms
>> > loop  24 delay  203 ms
>> > loop  25 delay  203 ms
>> > loop  26 delay  204 ms
>> > loop  27 delay  204 ms
>> > loop  28 delay  120 ms
>> > loop  29 delay   83 ms
>> > loop  30 delay  204 ms
>> > loop  31 delay  203 ms
>> > loop  32 delay  204 ms
>> > loop  33 delay  208 ms
>> > loop  34 delay  199 ms
>> > loop  35 delay  204 ms
>> > loop  36 delay  175 ms
>> > loop  37 delay   11 ms
>> > loop  38 delay  115 ms
>> > loop  39 delay  205 ms
>> > loop  40 delay  204 ms
>> > loop  41 delay   11 ms
>> > loop  42 delay   91 ms
>> > loop  43 delay  202 ms
>> > loop  44 delay  203 ms
>> > loop  45 delay  204 ms
>> > loop  46 delay  209 ms
>> > loop  47 delay  112 ms
>> > loop  48 delay   16 ms
>> > loop  49 delay   69 ms
>> > loop  50 delay  204 ms
>> > loop  51 delay   18 ms
>> > loop  52 delay   14 ms
>> > loop  53 delay   70 ms
>> > loop  54 delay   33 ms
>> > loop  55 delay  184 ms
>> > loop  56 delay  199 ms
>> > loop  57 delay  194 ms
>> > loop  58 delay  102 ms
>> > loop  59 delay  102 ms
>> > loop  60 delay   12 ms
>> > loop  61 delay  197 ms
>> > loop  62 delay  204 ms
>> > loop  63 delay  204 ms
>> > loop  64 delay  206 ms
>> > loop  65 delay   11 ms
>> > loop  66 delay  180 ms
>> > loop  67 delay  202 ms
>> > loop  68 delay   10 ms
>> > loop  69 delay   20 ms
>> > loop  70 delay  199 ms
>> > loop  71 delay  179 ms
>> > loop  72 delay  202 ms
>> > loop  73 delay   33 ms
>> > loop  74 delay   69 ms
>> > loop  75 delay   14 ms
>> > loop  76 delay   88 ms
>> > loop  77 delay  204 ms
>> > loop  78 delay  209 ms
>> > loop  79 delay  198 ms
>> > loop  80 delay  204 ms
>> > loop  81 delay   25 ms
>> > loop  82 delay   76 ms
>> > loop  83 delay  102 ms
>> > loop  84 delay  173 ms
>> > loop  85 delay   13 ms
>> > loop  86 delay   17 ms
>> > loop  87 delay   14 ms
>> > loop  88 delay  191 ms
>> > loop  89 delay  204 ms
>> > loop  90 delay  204 ms
>> > loop  91 delay  102 ms
>> > loop  92 delay   47 ms
>> > loop  93 delay   37 ms
>> > loop  94 delay  142 ms
>> > loop  95 delay  202 ms
>> > loop  96 delay  204 ms
>> > loop  97 delay  202 ms
>> > loop  98 delay  104 ms
>> > loop  99 delay   80 ms
>> > total time = 14193 ms
>> >
>> >
>> > ====== LINUX   RESULTS are as expected ======
>> >
>> > sh -c '/opt/jdk/bin/java -cp ./mach5-mesos-support-1.0-SNAPSHOT.jar
>> SleepLatency'
>> > Forked command at 6125
>> > loop   0 delay   10 ms
>> > loop   1 delay   11 ms
>> > loop   2 delay   10 ms
>> > loop   3 delay   10 ms
>> > loop   4 delay   10 ms
>> > loop   5 delay   10 ms
>> > loop   6 delay   10 ms
>> > loop   7 delay   10 ms
>> > loop   8 delay   10 ms
>> > loop   9 delay   10 ms
>> > loop  10 delay   10 ms
>> > loop  11 delay   10 ms
>> > loop  12 delay   10 ms
>> > loop  13 delay   10 ms
>> > loop  14 delay   10 ms
>> > loop  15 delay   10 ms
>> > loop  16 delay   10 ms
>> > loop  17 delay   10 ms
>> > loop  18 delay   10 ms
>> > loop  19 delay   11 ms
>> > loop  20 delay   10 ms
>> > loop  21 delay   10 ms
>> > loop  22 delay   10 ms
>> > loop  23 delay   10 ms
>> > loop  24 delay   10 ms
>> > loop  25 delay   11 ms
>> > loop  26 delay   10 ms
>> > loop  27 delay   10 ms
>> > loop  28 delay   10 ms
>> > loop  29 delay   10 ms
>> > loop  30 delay   10 ms
>> > loop  31 delay   10 ms
>> > loop  32 delay   10 ms
>> > loop  33 delay   10 ms
>> > loop  34 delay   11 ms
>> > loop  35 delay   10 ms
>> > loop  36 delay   10 ms
>> > loop  37 delay   11 ms
>> > loop  38 delay   10 ms
>> > loop  39 delay   10 ms
>> > loop  40 delay   11 ms
>> > loop  41 delay   10 ms
>> > loop  42 delay   10 ms
>> > loop  43 delay   11 ms
>> > loop  44 delay   10 ms
>> > loop  45 delay   10 ms
>> > loop  46 delay   10 ms
>> > loop  47 delay   10 ms
>> > loop  48 delay   10 ms
>> > loop  49 delay   10 ms
>> > loop  50 delay   10 ms
>> > loop  51 delay   10 ms
>> > loop  52 delay   11 ms
>> > loop  53 delay   10 ms
>> > loop  54 delay   10 ms
>> > loop  55 delay   10 ms
>> > loop  56 delay   10 ms
>> > loop  57 delay   10 ms
>> > loop  58 delay   10 ms
>> > loop  59 delay   10 ms
>> > loop  60 delay   10 ms
>> > loop  61 delay   10 ms
>> > loop  62 delay   11 ms
>> > loop  63 delay   10 ms
>> > loop  64 delay   10 ms
>> > loop  65 delay   11 ms
>> > loop  66 delay   10 ms
>> > loop  67 delay   10 ms
>> > loop  68 delay   10 ms
>> > loop  69 delay   10 ms
>> > loop  70 delay   10 ms
>> > loop  71 delay   10 ms
>> > loop  72 delay   11 ms
>> > loop  73 delay   10 ms
>> > loop  74 delay   10 ms
>> > loop  75 delay   10 ms
>> > loop  76 delay   11 ms
>> > loop  77 delay   10 ms
>> > loop  78 delay   10 ms
>> > loop  79 delay   10 ms
>> > loop  80 delay   11 ms
>> > loop  81 delay   10 ms
>> > loop  82 delay   10 ms
>> > loop  83 delay   10 ms
>> > loop  84 delay   10 ms
>> > loop  85 delay   10 ms
>> > loop  86 delay   10 ms
>> > loop  87 delay   10 ms
>> > loop  88 delay   10 ms
>> > loop  89 delay   10 ms
>> > loop  90 delay   10 ms
>> > loop  91 delay   10 ms
>> > loop  92 delay   10 ms
>> > loop  93 delay   10 ms
>> > loop  94 delay   10 ms
>> > loop  95 delay   10 ms
>> > loop  96 delay   10 ms
>> > loop  97 delay   10 ms
>> > loop  98 delay   10 ms
>> > loop  99 delay   10 ms
>> > total time =  1035 ms
>> >
>> >
>> >
>> >
>> >
>> >
>> > --
>> > Best Regards,
>> > Haosdent Huang
>>
>>
>
>
> --
> Best Regards,
> Haosdent Huang
>
>
>


-- 
Best Regards,
Haosdent Huang

Re: OSX 10.10.5 and mesos 0.28.1 -- 10 to 20 X difference in sleep() method compared to non mesos

Posted by "DiGiorgio, Mr. Rinaldo S." <rd...@pace.edu>.
On Jun 6, 2016, at 11:08, haosdent <ha...@gmail.com>> wrote:

I use OS X 10.11.4 but I think it should not related to this minor different on OS X version.
For settings, I disable `Enable Power Nap while plugged into a power adapter` in `Energy Saver`.

I assume you have a laptop, I have retested with power nap being set to off on an iMac and it did not make a difference. I will try it on a laptop.  The other 15 Macs are all towers. Maybe it is a clue, works on laptops but not on desktops.
On Mon, Jun 6, 2016 at 10:57 PM, DiGiorgio, Mr. Rinaldo S. <rd...@pace.edu>> wrote:


Thanks James and Haosdent,

I built my own version of mesos 1.0 and installed it on 10.11.5 and I am getting the same results as 10.10.5 with 0.28.1

Do either of you remember what you may have set on your OSX machines to default some of the desktop settings that may be causing this issue?


We are already turning off many desktop features since they are not relevant for our use case.



Received SUBSCRIBED event
Subscribed executor on dhcp-adc-twvpn-3-vpnpool-10-154-101-79.vpn.oracle.com<http://dhcp-adc-twvpn-3-vpnpool-10-154-101-79.vpn.oracle.com/>
Received LAUNCH event
Starting task test-sleep
sh -c 'cd /tmp && java SleepLatency'
Forked command at 2907
loop   0 delay   35 ms
loop   1 delay  108 ms
loop   2 delay  104 ms
loop   3 delay   57 ms
loop   4 delay  104 ms
loop   5 delay   93 ms
loop   6 delay   12 ms
loop   7 delay   17 ms
loop   8 delay  105 ms
loop   9 delay  109 ms


> On Jun 4, 2016, at 05:07, haosdent <ha...@gmail.com>> wrote:
>
> Hi, Rinaldo. I test your problem in my local Mesos (run in my mac). It looks normal in my side. I started it by
>
> ```
> mesos-execute --master="localhost:5050" --name="test-sleep" --command="cd /tmp && java SleepLatency"
> ```
>
> ```
> Registered executor on localhost
> Starting task test-sleep
> sh -c 'cd /tmp && java SleepLatency'
> Forked command at 42480
> loop   0 delay   11 ms
> loop   1 delay   12 ms
> loop   2 delay   11 ms
> loop   3 delay   13 ms
> loop   4 delay   12 ms
> loop   5 delay   12 ms
> loop   6 delay   12 ms
> loop   7 delay   12 ms
> loop   8 delay   12 ms
> loop   9 delay   11 ms
> loop  10 delay   12 ms
> loop  11 delay   13 ms
> loop  12 delay   11 ms
> loop  13 delay   11 ms
> loop  14 delay   12 ms
> loop  15 delay   12 ms
> loop  16 delay   13 ms
> loop  17 delay   12 ms
> loop  18 delay   11 ms
> loop  19 delay   12 ms
> loop  20 delay   12 ms
> loop  21 delay   11 ms
> loop  22 delay   12 ms
> loop  23 delay   11 ms
> loop  24 delay   12 ms
> loop  25 delay   12 ms
> loop  26 delay   12 ms
> loop  27 delay   12 ms
> loop  28 delay   13 ms
> loop  29 delay   12 ms
> loop  30 delay   12 ms
> loop  31 delay   11 ms
> loop  32 delay   11 ms
> loop  33 delay   11 ms
> loop  34 delay   13 ms
> loop  35 delay   10 ms
> loop  36 delay   12 ms
> loop  37 delay   11 ms
> loop  38 delay   12 ms
> loop  39 delay   12 ms
> loop  40 delay   12 ms
> loop  41 delay   12 ms
> loop  42 delay   12 ms
> loop  43 delay   11 ms
> loop  44 delay   12 ms
> loop  45 delay   12 ms
> loop  46 delay   12 ms
> loop  47 delay   12 ms
> loop  48 delay   12 ms
> loop  49 delay   12 ms
> loop  50 delay   12 ms
> loop  51 delay   12 ms
> loop  52 delay   12 ms
> loop  53 delay   13 ms
> loop  54 delay   11 ms
> loop  55 delay   12 ms
> loop  56 delay   12 ms
> loop  57 delay   12 ms
> loop  58 delay   12 ms
> loop  59 delay   11 ms
> loop  60 delay   11 ms
> loop  61 delay   11 ms
> loop  62 delay   11 ms
> loop  63 delay   12 ms
> loop  64 delay   12 ms
> loop  65 delay   12 ms
> loop  66 delay   12 ms
> loop  67 delay   12 ms
> loop  68 delay   11 ms
> loop  69 delay   13 ms
> loop  70 delay   12 ms
> loop  71 delay   10 ms
> loop  72 delay   12 ms
> loop  73 delay   10 ms
> loop  74 delay   11 ms
> loop  75 delay   12 ms
> loop  76 delay   10 ms
> loop  77 delay   11 ms
> loop  78 delay   12 ms
> loop  79 delay   10 ms
> loop  80 delay   12 ms
> loop  81 delay   12 ms
> loop  82 delay   11 ms
> loop  83 delay   11 ms
> loop  84 delay   12 ms
> loop  85 delay   11 ms
> loop  86 delay   12 ms
> loop  87 delay   12 ms
> loop  88 delay   12 ms
> loop  89 delay   11 ms
> loop  90 delay   12 ms
> loop  91 delay   12 ms
> loop  92 delay   13 ms
> loop  93 delay   12 ms
> loop  94 delay   11 ms
> loop  95 delay   10 ms
> loop  96 delay   12 ms
> loop  97 delay   11 ms
> loop  98 delay   12 ms
> loop  99 delay   12 ms
> total time =  1215 ms
> Command exited with status 0 (pid: 42480)
> ```
>
> On Sat, Jun 4, 2016 at 4:11 AM, DiGiorgio, Mr. Rinaldo S. <rd...@pace.edu>> wrote:
> Hi,
>
>         We are running the following Java application and we are getting unreasonable deltas in the actual amount time slept. On linux the results are as expected 10, 11, 12 but mostly 10ms.  Can you suggest any changes we can make or is this a known issue or a new issue to be investigated? When we run the same code on the same instance of OSX 10.10.5 without mesos  -- we get the expected results.
>
>
> public class SleepLatency {
>    static final int COUNT = 100;
>    static final long DELAY = 10L;
>
>    public static void main(String[] args) throws Exception {
>        long tstart = System.currentTimeMillis();
>        for (int i = 0; i < COUNT; i++) {
>            long t0 = System.currentTimeMillis();
>            Thread.sleep(DELAY);
>            long t1 = System.currentTimeMillis();
>            System.out.printf("loop %3d delay %4d ms%n", i, t1 - t0);
>        }
>        long tfinish = System.currentTimeMillis();
>        System.out.printf("total time = %5d ms%n", tfinish - tstart);
>    }
> }
>
> ====== OSX   RESULTS are 10 to 20 times  larger than LINUX Results below =====
>
> sh -c '/opt/jdk/bin/java -cp ./mach5-mesos-support-1.0-SNAPSHOT.jar SleepLatency'
> loop   0 delay  141 ms
> loop   1 delay  201 ms
> loop   2 delay   81 ms
> loop   3 delay   14 ms
> loop   4 delay  194 ms
> loop   5 delay  149 ms
> loop   6 delay  172 ms
> loop   7 delay  203 ms
> loop   8 delay  203 ms
> loop   9 delay  204 ms
> loop  10 delay  204 ms
> loop  11 delay  204 ms
> loop  12 delay  203 ms
> loop  13 delay  203 ms
> loop  14 delay   40 ms
> loop  15 delay  206 ms
> loop  16 delay  171 ms
> loop  17 delay  107 ms
> loop  18 delay   85 ms
> loop  19 delay  204 ms
> loop  20 delay  204 ms
> loop  21 delay  203 ms
> loop  22 delay  208 ms
> loop  23 delay  200 ms
> loop  24 delay  203 ms
> loop  25 delay  203 ms
> loop  26 delay  204 ms
> loop  27 delay  204 ms
> loop  28 delay  120 ms
> loop  29 delay   83 ms
> loop  30 delay  204 ms
> loop  31 delay  203 ms
> loop  32 delay  204 ms
> loop  33 delay  208 ms
> loop  34 delay  199 ms
> loop  35 delay  204 ms
> loop  36 delay  175 ms
> loop  37 delay   11 ms
> loop  38 delay  115 ms
> loop  39 delay  205 ms
> loop  40 delay  204 ms
> loop  41 delay   11 ms
> loop  42 delay   91 ms
> loop  43 delay  202 ms
> loop  44 delay  203 ms
> loop  45 delay  204 ms
> loop  46 delay  209 ms
> loop  47 delay  112 ms
> loop  48 delay   16 ms
> loop  49 delay   69 ms
> loop  50 delay  204 ms
> loop  51 delay   18 ms
> loop  52 delay   14 ms
> loop  53 delay   70 ms
> loop  54 delay   33 ms
> loop  55 delay  184 ms
> loop  56 delay  199 ms
> loop  57 delay  194 ms
> loop  58 delay  102 ms
> loop  59 delay  102 ms
> loop  60 delay   12 ms
> loop  61 delay  197 ms
> loop  62 delay  204 ms
> loop  63 delay  204 ms
> loop  64 delay  206 ms
> loop  65 delay   11 ms
> loop  66 delay  180 ms
> loop  67 delay  202 ms
> loop  68 delay   10 ms
> loop  69 delay   20 ms
> loop  70 delay  199 ms
> loop  71 delay  179 ms
> loop  72 delay  202 ms
> loop  73 delay   33 ms
> loop  74 delay   69 ms
> loop  75 delay   14 ms
> loop  76 delay   88 ms
> loop  77 delay  204 ms
> loop  78 delay  209 ms
> loop  79 delay  198 ms
> loop  80 delay  204 ms
> loop  81 delay   25 ms
> loop  82 delay   76 ms
> loop  83 delay  102 ms
> loop  84 delay  173 ms
> loop  85 delay   13 ms
> loop  86 delay   17 ms
> loop  87 delay   14 ms
> loop  88 delay  191 ms
> loop  89 delay  204 ms
> loop  90 delay  204 ms
> loop  91 delay  102 ms
> loop  92 delay   47 ms
> loop  93 delay   37 ms
> loop  94 delay  142 ms
> loop  95 delay  202 ms
> loop  96 delay  204 ms
> loop  97 delay  202 ms
> loop  98 delay  104 ms
> loop  99 delay   80 ms
> total time = 14193 ms
>
>
> ====== LINUX   RESULTS are as expected ======
>
> sh -c '/opt/jdk/bin/java -cp ./mach5-mesos-support-1.0-SNAPSHOT.jar SleepLatency'
> Forked command at 6125
> loop   0 delay   10 ms
> loop   1 delay   11 ms
> loop   2 delay   10 ms
> loop   3 delay   10 ms
> loop   4 delay   10 ms
> loop   5 delay   10 ms
> loop   6 delay   10 ms
> loop   7 delay   10 ms
> loop   8 delay   10 ms
> loop   9 delay   10 ms
> loop  10 delay   10 ms
> loop  11 delay   10 ms
> loop  12 delay   10 ms
> loop  13 delay   10 ms
> loop  14 delay   10 ms
> loop  15 delay   10 ms
> loop  16 delay   10 ms
> loop  17 delay   10 ms
> loop  18 delay   10 ms
> loop  19 delay   11 ms
> loop  20 delay   10 ms
> loop  21 delay   10 ms
> loop  22 delay   10 ms
> loop  23 delay   10 ms
> loop  24 delay   10 ms
> loop  25 delay   11 ms
> loop  26 delay   10 ms
> loop  27 delay   10 ms
> loop  28 delay   10 ms
> loop  29 delay   10 ms
> loop  30 delay   10 ms
> loop  31 delay   10 ms
> loop  32 delay   10 ms
> loop  33 delay   10 ms
> loop  34 delay   11 ms
> loop  35 delay   10 ms
> loop  36 delay   10 ms
> loop  37 delay   11 ms
> loop  38 delay   10 ms
> loop  39 delay   10 ms
> loop  40 delay   11 ms
> loop  41 delay   10 ms
> loop  42 delay   10 ms
> loop  43 delay   11 ms
> loop  44 delay   10 ms
> loop  45 delay   10 ms
> loop  46 delay   10 ms
> loop  47 delay   10 ms
> loop  48 delay   10 ms
> loop  49 delay   10 ms
> loop  50 delay   10 ms
> loop  51 delay   10 ms
> loop  52 delay   11 ms
> loop  53 delay   10 ms
> loop  54 delay   10 ms
> loop  55 delay   10 ms
> loop  56 delay   10 ms
> loop  57 delay   10 ms
> loop  58 delay   10 ms
> loop  59 delay   10 ms
> loop  60 delay   10 ms
> loop  61 delay   10 ms
> loop  62 delay   11 ms
> loop  63 delay   10 ms
> loop  64 delay   10 ms
> loop  65 delay   11 ms
> loop  66 delay   10 ms
> loop  67 delay   10 ms
> loop  68 delay   10 ms
> loop  69 delay   10 ms
> loop  70 delay   10 ms
> loop  71 delay   10 ms
> loop  72 delay   11 ms
> loop  73 delay   10 ms
> loop  74 delay   10 ms
> loop  75 delay   10 ms
> loop  76 delay   11 ms
> loop  77 delay   10 ms
> loop  78 delay   10 ms
> loop  79 delay   10 ms
> loop  80 delay   11 ms
> loop  81 delay   10 ms
> loop  82 delay   10 ms
> loop  83 delay   10 ms
> loop  84 delay   10 ms
> loop  85 delay   10 ms
> loop  86 delay   10 ms
> loop  87 delay   10 ms
> loop  88 delay   10 ms
> loop  89 delay   10 ms
> loop  90 delay   10 ms
> loop  91 delay   10 ms
> loop  92 delay   10 ms
> loop  93 delay   10 ms
> loop  94 delay   10 ms
> loop  95 delay   10 ms
> loop  96 delay   10 ms
> loop  97 delay   10 ms
> loop  98 delay   10 ms
> loop  99 delay   10 ms
> total time =  1035 ms
>
>
>
>
>
>
> --
> Best Regards,
> Haosdent Huang




--
Best Regards,
Haosdent Huang


Re: OSX 10.10.5 and mesos 0.28.1 -- 10 to 20 X difference in sleep() method compared to non mesos

Posted by haosdent <ha...@gmail.com>.
I use OS X 10.11.4 but I think it should not related to this minor
different on OS X version.
For settings, I disable `Enable Power Nap while plugged into a power
adapter` in `Energy Saver`.

On Mon, Jun 6, 2016 at 10:57 PM, DiGiorgio, Mr. Rinaldo S. <
rdigiorgio@pace.edu> wrote:

> Thanks James and Haosdent,
>
> I built my own version of mesos 1.0 and installed it on 10.11.5 and I am
> getting the same results as 10.10.5 with 0.28.1
>
> Do either of you remember what you may have set on your OSX machines to
> default some of the desktop settings that may be causing this issue?
>
>
> We are already turning off many desktop features since they are not
> relevant for our use case.
>
>
>
> Received SUBSCRIBED event
> Subscribed executor on
> dhcp-adc-twvpn-3-vpnpool-10-154-101-79.vpn.oracle.com
> Received LAUNCH event
> Starting task test-sleep
> sh -c 'cd /tmp && java SleepLatency'
> Forked command at 2907
> loop   0 delay   35 ms
> loop   1 delay  108 ms
> loop   2 delay  104 ms
> loop   3 delay   57 ms
> loop   4 delay  104 ms
> loop   5 delay   93 ms
> loop   6 delay   12 ms
> loop   7 delay   17 ms
> loop   8 delay  105 ms
> loop   9 delay  109 ms
>
>
> > On Jun 4, 2016, at 05:07, haosdent <ha...@gmail.com> wrote:
> >
> > Hi, Rinaldo. I test your problem in my local Mesos (run in my mac). It
> looks normal in my side. I started it by
> >
> > ```
> > mesos-execute --master="localhost:5050" --name="test-sleep"
> --command="cd /tmp && java SleepLatency"
> > ```
> >
> > ```
> > Registered executor on localhost
> > Starting task test-sleep
> > sh -c 'cd /tmp && java SleepLatency'
> > Forked command at 42480
> > loop   0 delay   11 ms
> > loop   1 delay   12 ms
> > loop   2 delay   11 ms
> > loop   3 delay   13 ms
> > loop   4 delay   12 ms
> > loop   5 delay   12 ms
> > loop   6 delay   12 ms
> > loop   7 delay   12 ms
> > loop   8 delay   12 ms
> > loop   9 delay   11 ms
> > loop  10 delay   12 ms
> > loop  11 delay   13 ms
> > loop  12 delay   11 ms
> > loop  13 delay   11 ms
> > loop  14 delay   12 ms
> > loop  15 delay   12 ms
> > loop  16 delay   13 ms
> > loop  17 delay   12 ms
> > loop  18 delay   11 ms
> > loop  19 delay   12 ms
> > loop  20 delay   12 ms
> > loop  21 delay   11 ms
> > loop  22 delay   12 ms
> > loop  23 delay   11 ms
> > loop  24 delay   12 ms
> > loop  25 delay   12 ms
> > loop  26 delay   12 ms
> > loop  27 delay   12 ms
> > loop  28 delay   13 ms
> > loop  29 delay   12 ms
> > loop  30 delay   12 ms
> > loop  31 delay   11 ms
> > loop  32 delay   11 ms
> > loop  33 delay   11 ms
> > loop  34 delay   13 ms
> > loop  35 delay   10 ms
> > loop  36 delay   12 ms
> > loop  37 delay   11 ms
> > loop  38 delay   12 ms
> > loop  39 delay   12 ms
> > loop  40 delay   12 ms
> > loop  41 delay   12 ms
> > loop  42 delay   12 ms
> > loop  43 delay   11 ms
> > loop  44 delay   12 ms
> > loop  45 delay   12 ms
> > loop  46 delay   12 ms
> > loop  47 delay   12 ms
> > loop  48 delay   12 ms
> > loop  49 delay   12 ms
> > loop  50 delay   12 ms
> > loop  51 delay   12 ms
> > loop  52 delay   12 ms
> > loop  53 delay   13 ms
> > loop  54 delay   11 ms
> > loop  55 delay   12 ms
> > loop  56 delay   12 ms
> > loop  57 delay   12 ms
> > loop  58 delay   12 ms
> > loop  59 delay   11 ms
> > loop  60 delay   11 ms
> > loop  61 delay   11 ms
> > loop  62 delay   11 ms
> > loop  63 delay   12 ms
> > loop  64 delay   12 ms
> > loop  65 delay   12 ms
> > loop  66 delay   12 ms
> > loop  67 delay   12 ms
> > loop  68 delay   11 ms
> > loop  69 delay   13 ms
> > loop  70 delay   12 ms
> > loop  71 delay   10 ms
> > loop  72 delay   12 ms
> > loop  73 delay   10 ms
> > loop  74 delay   11 ms
> > loop  75 delay   12 ms
> > loop  76 delay   10 ms
> > loop  77 delay   11 ms
> > loop  78 delay   12 ms
> > loop  79 delay   10 ms
> > loop  80 delay   12 ms
> > loop  81 delay   12 ms
> > loop  82 delay   11 ms
> > loop  83 delay   11 ms
> > loop  84 delay   12 ms
> > loop  85 delay   11 ms
> > loop  86 delay   12 ms
> > loop  87 delay   12 ms
> > loop  88 delay   12 ms
> > loop  89 delay   11 ms
> > loop  90 delay   12 ms
> > loop  91 delay   12 ms
> > loop  92 delay   13 ms
> > loop  93 delay   12 ms
> > loop  94 delay   11 ms
> > loop  95 delay   10 ms
> > loop  96 delay   12 ms
> > loop  97 delay   11 ms
> > loop  98 delay   12 ms
> > loop  99 delay   12 ms
> > total time =  1215 ms
> > Command exited with status 0 (pid: 42480)
> > ```
> >
> > On Sat, Jun 4, 2016 at 4:11 AM, DiGiorgio, Mr. Rinaldo S. <
> rdigiorgio@pace.edu> wrote:
> > Hi,
> >
> >         We are running the following Java application and we are getting
> unreasonable deltas in the actual amount time slept. On linux the results
> are as expected 10, 11, 12 but mostly 10ms.  Can you suggest any changes we
> can make or is this a known issue or a new issue to be investigated? When
> we run the same code on the same instance of OSX 10.10.5 without mesos  --
> we get the expected results.
> >
> >
> > public class SleepLatency {
> >    static final int COUNT = 100;
> >    static final long DELAY = 10L;
> >
> >    public static void main(String[] args) throws Exception {
> >        long tstart = System.currentTimeMillis();
> >        for (int i = 0; i < COUNT; i++) {
> >            long t0 = System.currentTimeMillis();
> >            Thread.sleep(DELAY);
> >            long t1 = System.currentTimeMillis();
> >            System.out.printf("loop %3d delay %4d ms%n", i, t1 - t0);
> >        }
> >        long tfinish = System.currentTimeMillis();
> >        System.out.printf("total time = %5d ms%n", tfinish - tstart);
> >    }
> > }
> >
> > ====== OSX   RESULTS are 10 to 20 times  larger than LINUX Results below
> =====
> >
> > sh -c '/opt/jdk/bin/java -cp ./mach5-mesos-support-1.0-SNAPSHOT.jar
> SleepLatency'
> > loop   0 delay  141 ms
> > loop   1 delay  201 ms
> > loop   2 delay   81 ms
> > loop   3 delay   14 ms
> > loop   4 delay  194 ms
> > loop   5 delay  149 ms
> > loop   6 delay  172 ms
> > loop   7 delay  203 ms
> > loop   8 delay  203 ms
> > loop   9 delay  204 ms
> > loop  10 delay  204 ms
> > loop  11 delay  204 ms
> > loop  12 delay  203 ms
> > loop  13 delay  203 ms
> > loop  14 delay   40 ms
> > loop  15 delay  206 ms
> > loop  16 delay  171 ms
> > loop  17 delay  107 ms
> > loop  18 delay   85 ms
> > loop  19 delay  204 ms
> > loop  20 delay  204 ms
> > loop  21 delay  203 ms
> > loop  22 delay  208 ms
> > loop  23 delay  200 ms
> > loop  24 delay  203 ms
> > loop  25 delay  203 ms
> > loop  26 delay  204 ms
> > loop  27 delay  204 ms
> > loop  28 delay  120 ms
> > loop  29 delay   83 ms
> > loop  30 delay  204 ms
> > loop  31 delay  203 ms
> > loop  32 delay  204 ms
> > loop  33 delay  208 ms
> > loop  34 delay  199 ms
> > loop  35 delay  204 ms
> > loop  36 delay  175 ms
> > loop  37 delay   11 ms
> > loop  38 delay  115 ms
> > loop  39 delay  205 ms
> > loop  40 delay  204 ms
> > loop  41 delay   11 ms
> > loop  42 delay   91 ms
> > loop  43 delay  202 ms
> > loop  44 delay  203 ms
> > loop  45 delay  204 ms
> > loop  46 delay  209 ms
> > loop  47 delay  112 ms
> > loop  48 delay   16 ms
> > loop  49 delay   69 ms
> > loop  50 delay  204 ms
> > loop  51 delay   18 ms
> > loop  52 delay   14 ms
> > loop  53 delay   70 ms
> > loop  54 delay   33 ms
> > loop  55 delay  184 ms
> > loop  56 delay  199 ms
> > loop  57 delay  194 ms
> > loop  58 delay  102 ms
> > loop  59 delay  102 ms
> > loop  60 delay   12 ms
> > loop  61 delay  197 ms
> > loop  62 delay  204 ms
> > loop  63 delay  204 ms
> > loop  64 delay  206 ms
> > loop  65 delay   11 ms
> > loop  66 delay  180 ms
> > loop  67 delay  202 ms
> > loop  68 delay   10 ms
> > loop  69 delay   20 ms
> > loop  70 delay  199 ms
> > loop  71 delay  179 ms
> > loop  72 delay  202 ms
> > loop  73 delay   33 ms
> > loop  74 delay   69 ms
> > loop  75 delay   14 ms
> > loop  76 delay   88 ms
> > loop  77 delay  204 ms
> > loop  78 delay  209 ms
> > loop  79 delay  198 ms
> > loop  80 delay  204 ms
> > loop  81 delay   25 ms
> > loop  82 delay   76 ms
> > loop  83 delay  102 ms
> > loop  84 delay  173 ms
> > loop  85 delay   13 ms
> > loop  86 delay   17 ms
> > loop  87 delay   14 ms
> > loop  88 delay  191 ms
> > loop  89 delay  204 ms
> > loop  90 delay  204 ms
> > loop  91 delay  102 ms
> > loop  92 delay   47 ms
> > loop  93 delay   37 ms
> > loop  94 delay  142 ms
> > loop  95 delay  202 ms
> > loop  96 delay  204 ms
> > loop  97 delay  202 ms
> > loop  98 delay  104 ms
> > loop  99 delay   80 ms
> > total time = 14193 ms
> >
> >
> > ====== LINUX   RESULTS are as expected ======
> >
> > sh -c '/opt/jdk/bin/java -cp ./mach5-mesos-support-1.0-SNAPSHOT.jar
> SleepLatency'
> > Forked command at 6125
> > loop   0 delay   10 ms
> > loop   1 delay   11 ms
> > loop   2 delay   10 ms
> > loop   3 delay   10 ms
> > loop   4 delay   10 ms
> > loop   5 delay   10 ms
> > loop   6 delay   10 ms
> > loop   7 delay   10 ms
> > loop   8 delay   10 ms
> > loop   9 delay   10 ms
> > loop  10 delay   10 ms
> > loop  11 delay   10 ms
> > loop  12 delay   10 ms
> > loop  13 delay   10 ms
> > loop  14 delay   10 ms
> > loop  15 delay   10 ms
> > loop  16 delay   10 ms
> > loop  17 delay   10 ms
> > loop  18 delay   10 ms
> > loop  19 delay   11 ms
> > loop  20 delay   10 ms
> > loop  21 delay   10 ms
> > loop  22 delay   10 ms
> > loop  23 delay   10 ms
> > loop  24 delay   10 ms
> > loop  25 delay   11 ms
> > loop  26 delay   10 ms
> > loop  27 delay   10 ms
> > loop  28 delay   10 ms
> > loop  29 delay   10 ms
> > loop  30 delay   10 ms
> > loop  31 delay   10 ms
> > loop  32 delay   10 ms
> > loop  33 delay   10 ms
> > loop  34 delay   11 ms
> > loop  35 delay   10 ms
> > loop  36 delay   10 ms
> > loop  37 delay   11 ms
> > loop  38 delay   10 ms
> > loop  39 delay   10 ms
> > loop  40 delay   11 ms
> > loop  41 delay   10 ms
> > loop  42 delay   10 ms
> > loop  43 delay   11 ms
> > loop  44 delay   10 ms
> > loop  45 delay   10 ms
> > loop  46 delay   10 ms
> > loop  47 delay   10 ms
> > loop  48 delay   10 ms
> > loop  49 delay   10 ms
> > loop  50 delay   10 ms
> > loop  51 delay   10 ms
> > loop  52 delay   11 ms
> > loop  53 delay   10 ms
> > loop  54 delay   10 ms
> > loop  55 delay   10 ms
> > loop  56 delay   10 ms
> > loop  57 delay   10 ms
> > loop  58 delay   10 ms
> > loop  59 delay   10 ms
> > loop  60 delay   10 ms
> > loop  61 delay   10 ms
> > loop  62 delay   11 ms
> > loop  63 delay   10 ms
> > loop  64 delay   10 ms
> > loop  65 delay   11 ms
> > loop  66 delay   10 ms
> > loop  67 delay   10 ms
> > loop  68 delay   10 ms
> > loop  69 delay   10 ms
> > loop  70 delay   10 ms
> > loop  71 delay   10 ms
> > loop  72 delay   11 ms
> > loop  73 delay   10 ms
> > loop  74 delay   10 ms
> > loop  75 delay   10 ms
> > loop  76 delay   11 ms
> > loop  77 delay   10 ms
> > loop  78 delay   10 ms
> > loop  79 delay   10 ms
> > loop  80 delay   11 ms
> > loop  81 delay   10 ms
> > loop  82 delay   10 ms
> > loop  83 delay   10 ms
> > loop  84 delay   10 ms
> > loop  85 delay   10 ms
> > loop  86 delay   10 ms
> > loop  87 delay   10 ms
> > loop  88 delay   10 ms
> > loop  89 delay   10 ms
> > loop  90 delay   10 ms
> > loop  91 delay   10 ms
> > loop  92 delay   10 ms
> > loop  93 delay   10 ms
> > loop  94 delay   10 ms
> > loop  95 delay   10 ms
> > loop  96 delay   10 ms
> > loop  97 delay   10 ms
> > loop  98 delay   10 ms
> > loop  99 delay   10 ms
> > total time =  1035 ms
> >
> >
> >
> >
> >
> >
> > --
> > Best Regards,
> > Haosdent Huang
>
>


-- 
Best Regards,
Haosdent Huang

Re: OSX 10.10.5 and mesos 0.28.1 -- 10 to 20 X difference in sleep() method compared to non mesos

Posted by "DiGiorgio, Mr. Rinaldo S." <rd...@pace.edu>.
Thanks James and Haosdent,

I built my own version of mesos 1.0 and installed it on 10.11.5 and I am getting the same results as 10.10.5 with 0.28.1

Do either of you remember what you may have set on your OSX machines to default some of the desktop settings that may be causing this issue?


We are already turning off many desktop features since they are not relevant for our use case. 



Received SUBSCRIBED event
Subscribed executor on dhcp-adc-twvpn-3-vpnpool-10-154-101-79.vpn.oracle.com
Received LAUNCH event
Starting task test-sleep
sh -c 'cd /tmp && java SleepLatency'
Forked command at 2907
loop   0 delay   35 ms
loop   1 delay  108 ms
loop   2 delay  104 ms
loop   3 delay   57 ms
loop   4 delay  104 ms
loop   5 delay   93 ms
loop   6 delay   12 ms
loop   7 delay   17 ms
loop   8 delay  105 ms
loop   9 delay  109 ms


> On Jun 4, 2016, at 05:07, haosdent <ha...@gmail.com> wrote:
> 
> Hi, Rinaldo. I test your problem in my local Mesos (run in my mac). It looks normal in my side. I started it by
> 
> ```
> mesos-execute --master="localhost:5050" --name="test-sleep" --command="cd /tmp && java SleepLatency"
> ```
> 
> ```
> Registered executor on localhost
> Starting task test-sleep
> sh -c 'cd /tmp && java SleepLatency'
> Forked command at 42480
> loop   0 delay   11 ms
> loop   1 delay   12 ms
> loop   2 delay   11 ms
> loop   3 delay   13 ms
> loop   4 delay   12 ms
> loop   5 delay   12 ms
> loop   6 delay   12 ms
> loop   7 delay   12 ms
> loop   8 delay   12 ms
> loop   9 delay   11 ms
> loop  10 delay   12 ms
> loop  11 delay   13 ms
> loop  12 delay   11 ms
> loop  13 delay   11 ms
> loop  14 delay   12 ms
> loop  15 delay   12 ms
> loop  16 delay   13 ms
> loop  17 delay   12 ms
> loop  18 delay   11 ms
> loop  19 delay   12 ms
> loop  20 delay   12 ms
> loop  21 delay   11 ms
> loop  22 delay   12 ms
> loop  23 delay   11 ms
> loop  24 delay   12 ms
> loop  25 delay   12 ms
> loop  26 delay   12 ms
> loop  27 delay   12 ms
> loop  28 delay   13 ms
> loop  29 delay   12 ms
> loop  30 delay   12 ms
> loop  31 delay   11 ms
> loop  32 delay   11 ms
> loop  33 delay   11 ms
> loop  34 delay   13 ms
> loop  35 delay   10 ms
> loop  36 delay   12 ms
> loop  37 delay   11 ms
> loop  38 delay   12 ms
> loop  39 delay   12 ms
> loop  40 delay   12 ms
> loop  41 delay   12 ms
> loop  42 delay   12 ms
> loop  43 delay   11 ms
> loop  44 delay   12 ms
> loop  45 delay   12 ms
> loop  46 delay   12 ms
> loop  47 delay   12 ms
> loop  48 delay   12 ms
> loop  49 delay   12 ms
> loop  50 delay   12 ms
> loop  51 delay   12 ms
> loop  52 delay   12 ms
> loop  53 delay   13 ms
> loop  54 delay   11 ms
> loop  55 delay   12 ms
> loop  56 delay   12 ms
> loop  57 delay   12 ms
> loop  58 delay   12 ms
> loop  59 delay   11 ms
> loop  60 delay   11 ms
> loop  61 delay   11 ms
> loop  62 delay   11 ms
> loop  63 delay   12 ms
> loop  64 delay   12 ms
> loop  65 delay   12 ms
> loop  66 delay   12 ms
> loop  67 delay   12 ms
> loop  68 delay   11 ms
> loop  69 delay   13 ms
> loop  70 delay   12 ms
> loop  71 delay   10 ms
> loop  72 delay   12 ms
> loop  73 delay   10 ms
> loop  74 delay   11 ms
> loop  75 delay   12 ms
> loop  76 delay   10 ms
> loop  77 delay   11 ms
> loop  78 delay   12 ms
> loop  79 delay   10 ms
> loop  80 delay   12 ms
> loop  81 delay   12 ms
> loop  82 delay   11 ms
> loop  83 delay   11 ms
> loop  84 delay   12 ms
> loop  85 delay   11 ms
> loop  86 delay   12 ms
> loop  87 delay   12 ms
> loop  88 delay   12 ms
> loop  89 delay   11 ms
> loop  90 delay   12 ms
> loop  91 delay   12 ms
> loop  92 delay   13 ms
> loop  93 delay   12 ms
> loop  94 delay   11 ms
> loop  95 delay   10 ms
> loop  96 delay   12 ms
> loop  97 delay   11 ms
> loop  98 delay   12 ms
> loop  99 delay   12 ms
> total time =  1215 ms
> Command exited with status 0 (pid: 42480)
> ```
> 
> On Sat, Jun 4, 2016 at 4:11 AM, DiGiorgio, Mr. Rinaldo S. <rd...@pace.edu> wrote:
> Hi,
> 
>         We are running the following Java application and we are getting unreasonable deltas in the actual amount time slept. On linux the results are as expected 10, 11, 12 but mostly 10ms.  Can you suggest any changes we can make or is this a known issue or a new issue to be investigated? When we run the same code on the same instance of OSX 10.10.5 without mesos  -- we get the expected results.
> 
> 
> public class SleepLatency {
>    static final int COUNT = 100;
>    static final long DELAY = 10L;
> 
>    public static void main(String[] args) throws Exception {
>        long tstart = System.currentTimeMillis();
>        for (int i = 0; i < COUNT; i++) {
>            long t0 = System.currentTimeMillis();
>            Thread.sleep(DELAY);
>            long t1 = System.currentTimeMillis();
>            System.out.printf("loop %3d delay %4d ms%n", i, t1 - t0);
>        }
>        long tfinish = System.currentTimeMillis();
>        System.out.printf("total time = %5d ms%n", tfinish - tstart);
>    }
> }
> 
> ====== OSX   RESULTS are 10 to 20 times  larger than LINUX Results below =====
> 
> sh -c '/opt/jdk/bin/java -cp ./mach5-mesos-support-1.0-SNAPSHOT.jar SleepLatency'
> loop   0 delay  141 ms
> loop   1 delay  201 ms
> loop   2 delay   81 ms
> loop   3 delay   14 ms
> loop   4 delay  194 ms
> loop   5 delay  149 ms
> loop   6 delay  172 ms
> loop   7 delay  203 ms
> loop   8 delay  203 ms
> loop   9 delay  204 ms
> loop  10 delay  204 ms
> loop  11 delay  204 ms
> loop  12 delay  203 ms
> loop  13 delay  203 ms
> loop  14 delay   40 ms
> loop  15 delay  206 ms
> loop  16 delay  171 ms
> loop  17 delay  107 ms
> loop  18 delay   85 ms
> loop  19 delay  204 ms
> loop  20 delay  204 ms
> loop  21 delay  203 ms
> loop  22 delay  208 ms
> loop  23 delay  200 ms
> loop  24 delay  203 ms
> loop  25 delay  203 ms
> loop  26 delay  204 ms
> loop  27 delay  204 ms
> loop  28 delay  120 ms
> loop  29 delay   83 ms
> loop  30 delay  204 ms
> loop  31 delay  203 ms
> loop  32 delay  204 ms
> loop  33 delay  208 ms
> loop  34 delay  199 ms
> loop  35 delay  204 ms
> loop  36 delay  175 ms
> loop  37 delay   11 ms
> loop  38 delay  115 ms
> loop  39 delay  205 ms
> loop  40 delay  204 ms
> loop  41 delay   11 ms
> loop  42 delay   91 ms
> loop  43 delay  202 ms
> loop  44 delay  203 ms
> loop  45 delay  204 ms
> loop  46 delay  209 ms
> loop  47 delay  112 ms
> loop  48 delay   16 ms
> loop  49 delay   69 ms
> loop  50 delay  204 ms
> loop  51 delay   18 ms
> loop  52 delay   14 ms
> loop  53 delay   70 ms
> loop  54 delay   33 ms
> loop  55 delay  184 ms
> loop  56 delay  199 ms
> loop  57 delay  194 ms
> loop  58 delay  102 ms
> loop  59 delay  102 ms
> loop  60 delay   12 ms
> loop  61 delay  197 ms
> loop  62 delay  204 ms
> loop  63 delay  204 ms
> loop  64 delay  206 ms
> loop  65 delay   11 ms
> loop  66 delay  180 ms
> loop  67 delay  202 ms
> loop  68 delay   10 ms
> loop  69 delay   20 ms
> loop  70 delay  199 ms
> loop  71 delay  179 ms
> loop  72 delay  202 ms
> loop  73 delay   33 ms
> loop  74 delay   69 ms
> loop  75 delay   14 ms
> loop  76 delay   88 ms
> loop  77 delay  204 ms
> loop  78 delay  209 ms
> loop  79 delay  198 ms
> loop  80 delay  204 ms
> loop  81 delay   25 ms
> loop  82 delay   76 ms
> loop  83 delay  102 ms
> loop  84 delay  173 ms
> loop  85 delay   13 ms
> loop  86 delay   17 ms
> loop  87 delay   14 ms
> loop  88 delay  191 ms
> loop  89 delay  204 ms
> loop  90 delay  204 ms
> loop  91 delay  102 ms
> loop  92 delay   47 ms
> loop  93 delay   37 ms
> loop  94 delay  142 ms
> loop  95 delay  202 ms
> loop  96 delay  204 ms
> loop  97 delay  202 ms
> loop  98 delay  104 ms
> loop  99 delay   80 ms
> total time = 14193 ms
> 
> 
> ====== LINUX   RESULTS are as expected ======
> 
> sh -c '/opt/jdk/bin/java -cp ./mach5-mesos-support-1.0-SNAPSHOT.jar SleepLatency'
> Forked command at 6125
> loop   0 delay   10 ms
> loop   1 delay   11 ms
> loop   2 delay   10 ms
> loop   3 delay   10 ms
> loop   4 delay   10 ms
> loop   5 delay   10 ms
> loop   6 delay   10 ms
> loop   7 delay   10 ms
> loop   8 delay   10 ms
> loop   9 delay   10 ms
> loop  10 delay   10 ms
> loop  11 delay   10 ms
> loop  12 delay   10 ms
> loop  13 delay   10 ms
> loop  14 delay   10 ms
> loop  15 delay   10 ms
> loop  16 delay   10 ms
> loop  17 delay   10 ms
> loop  18 delay   10 ms
> loop  19 delay   11 ms
> loop  20 delay   10 ms
> loop  21 delay   10 ms
> loop  22 delay   10 ms
> loop  23 delay   10 ms
> loop  24 delay   10 ms
> loop  25 delay   11 ms
> loop  26 delay   10 ms
> loop  27 delay   10 ms
> loop  28 delay   10 ms
> loop  29 delay   10 ms
> loop  30 delay   10 ms
> loop  31 delay   10 ms
> loop  32 delay   10 ms
> loop  33 delay   10 ms
> loop  34 delay   11 ms
> loop  35 delay   10 ms
> loop  36 delay   10 ms
> loop  37 delay   11 ms
> loop  38 delay   10 ms
> loop  39 delay   10 ms
> loop  40 delay   11 ms
> loop  41 delay   10 ms
> loop  42 delay   10 ms
> loop  43 delay   11 ms
> loop  44 delay   10 ms
> loop  45 delay   10 ms
> loop  46 delay   10 ms
> loop  47 delay   10 ms
> loop  48 delay   10 ms
> loop  49 delay   10 ms
> loop  50 delay   10 ms
> loop  51 delay   10 ms
> loop  52 delay   11 ms
> loop  53 delay   10 ms
> loop  54 delay   10 ms
> loop  55 delay   10 ms
> loop  56 delay   10 ms
> loop  57 delay   10 ms
> loop  58 delay   10 ms
> loop  59 delay   10 ms
> loop  60 delay   10 ms
> loop  61 delay   10 ms
> loop  62 delay   11 ms
> loop  63 delay   10 ms
> loop  64 delay   10 ms
> loop  65 delay   11 ms
> loop  66 delay   10 ms
> loop  67 delay   10 ms
> loop  68 delay   10 ms
> loop  69 delay   10 ms
> loop  70 delay   10 ms
> loop  71 delay   10 ms
> loop  72 delay   11 ms
> loop  73 delay   10 ms
> loop  74 delay   10 ms
> loop  75 delay   10 ms
> loop  76 delay   11 ms
> loop  77 delay   10 ms
> loop  78 delay   10 ms
> loop  79 delay   10 ms
> loop  80 delay   11 ms
> loop  81 delay   10 ms
> loop  82 delay   10 ms
> loop  83 delay   10 ms
> loop  84 delay   10 ms
> loop  85 delay   10 ms
> loop  86 delay   10 ms
> loop  87 delay   10 ms
> loop  88 delay   10 ms
> loop  89 delay   10 ms
> loop  90 delay   10 ms
> loop  91 delay   10 ms
> loop  92 delay   10 ms
> loop  93 delay   10 ms
> loop  94 delay   10 ms
> loop  95 delay   10 ms
> loop  96 delay   10 ms
> loop  97 delay   10 ms
> loop  98 delay   10 ms
> loop  99 delay   10 ms
> total time =  1035 ms
> 
> 
> 
> 
> 
> 
> -- 
> Best Regards,
> Haosdent Huang


Re: OSX 10.10.5 and mesos 0.28.1 -- 10 to 20 X difference in sleep() method compared to non mesos

Posted by haosdent <ha...@gmail.com>.
Hi, Rinaldo. I test your problem in my local Mesos (run in my mac). It
looks normal in my side. I started it by

```
mesos-execute --master="localhost:5050" --name="test-sleep" --command="cd
/tmp && java SleepLatency"
```

```
Registered executor on localhost
Starting task test-sleep
sh -c 'cd /tmp && java SleepLatency'
Forked command at 42480
loop   0 delay   11 ms
loop   1 delay   12 ms
loop   2 delay   11 ms
loop   3 delay   13 ms
loop   4 delay   12 ms
loop   5 delay   12 ms
loop   6 delay   12 ms
loop   7 delay   12 ms
loop   8 delay   12 ms
loop   9 delay   11 ms
loop  10 delay   12 ms
loop  11 delay   13 ms
loop  12 delay   11 ms
loop  13 delay   11 ms
loop  14 delay   12 ms
loop  15 delay   12 ms
loop  16 delay   13 ms
loop  17 delay   12 ms
loop  18 delay   11 ms
loop  19 delay   12 ms
loop  20 delay   12 ms
loop  21 delay   11 ms
loop  22 delay   12 ms
loop  23 delay   11 ms
loop  24 delay   12 ms
loop  25 delay   12 ms
loop  26 delay   12 ms
loop  27 delay   12 ms
loop  28 delay   13 ms
loop  29 delay   12 ms
loop  30 delay   12 ms
loop  31 delay   11 ms
loop  32 delay   11 ms
loop  33 delay   11 ms
loop  34 delay   13 ms
loop  35 delay   10 ms
loop  36 delay   12 ms
loop  37 delay   11 ms
loop  38 delay   12 ms
loop  39 delay   12 ms
loop  40 delay   12 ms
loop  41 delay   12 ms
loop  42 delay   12 ms
loop  43 delay   11 ms
loop  44 delay   12 ms
loop  45 delay   12 ms
loop  46 delay   12 ms
loop  47 delay   12 ms
loop  48 delay   12 ms
loop  49 delay   12 ms
loop  50 delay   12 ms
loop  51 delay   12 ms
loop  52 delay   12 ms
loop  53 delay   13 ms
loop  54 delay   11 ms
loop  55 delay   12 ms
loop  56 delay   12 ms
loop  57 delay   12 ms
loop  58 delay   12 ms
loop  59 delay   11 ms
loop  60 delay   11 ms
loop  61 delay   11 ms
loop  62 delay   11 ms
loop  63 delay   12 ms
loop  64 delay   12 ms
loop  65 delay   12 ms
loop  66 delay   12 ms
loop  67 delay   12 ms
loop  68 delay   11 ms
loop  69 delay   13 ms
loop  70 delay   12 ms
loop  71 delay   10 ms
loop  72 delay   12 ms
loop  73 delay   10 ms
loop  74 delay   11 ms
loop  75 delay   12 ms
loop  76 delay   10 ms
loop  77 delay   11 ms
loop  78 delay   12 ms
loop  79 delay   10 ms
loop  80 delay   12 ms
loop  81 delay   12 ms
loop  82 delay   11 ms
loop  83 delay   11 ms
loop  84 delay   12 ms
loop  85 delay   11 ms
loop  86 delay   12 ms
loop  87 delay   12 ms
loop  88 delay   12 ms
loop  89 delay   11 ms
loop  90 delay   12 ms
loop  91 delay   12 ms
loop  92 delay   13 ms
loop  93 delay   12 ms
loop  94 delay   11 ms
loop  95 delay   10 ms
loop  96 delay   12 ms
loop  97 delay   11 ms
loop  98 delay   12 ms
loop  99 delay   12 ms
total time =  1215 ms
Command exited with status 0 (pid: 42480)
```

On Sat, Jun 4, 2016 at 4:11 AM, DiGiorgio, Mr. Rinaldo S. <
rdigiorgio@pace.edu> wrote:

> Hi,
>
>         We are running the following Java application and we are getting
> unreasonable deltas in the actual amount time slept. On linux the results
> are as expected 10, 11, 12 but mostly 10ms.  Can you suggest any changes we
> can make or is this a known issue or a new issue to be investigated? When
> we run the same code on the same instance of OSX 10.10.5 without mesos  --
> we get the expected results.
>
>
> public class SleepLatency {
>    static final int COUNT = 100;
>    static final long DELAY = 10L;
>
>    public static void main(String[] args) throws Exception {
>        long tstart = System.currentTimeMillis();
>        for (int i = 0; i < COUNT; i++) {
>            long t0 = System.currentTimeMillis();
>            Thread.sleep(DELAY);
>            long t1 = System.currentTimeMillis();
>            System.out.printf("loop %3d delay %4d ms%n", i, t1 - t0);
>        }
>        long tfinish = System.currentTimeMillis();
>        System.out.printf("total time = %5d ms%n", tfinish - tstart);
>    }
> }
>
> ====== OSX   RESULTS are 10 to 20 times  larger than LINUX Results below
> =====
>
> sh -c '/opt/jdk/bin/java -cp ./mach5-mesos-support-1.0-SNAPSHOT.jar
> SleepLatency'
> loop   0 delay  141 ms
> loop   1 delay  201 ms
> loop   2 delay   81 ms
> loop   3 delay   14 ms
> loop   4 delay  194 ms
> loop   5 delay  149 ms
> loop   6 delay  172 ms
> loop   7 delay  203 ms
> loop   8 delay  203 ms
> loop   9 delay  204 ms
> loop  10 delay  204 ms
> loop  11 delay  204 ms
> loop  12 delay  203 ms
> loop  13 delay  203 ms
> loop  14 delay   40 ms
> loop  15 delay  206 ms
> loop  16 delay  171 ms
> loop  17 delay  107 ms
> loop  18 delay   85 ms
> loop  19 delay  204 ms
> loop  20 delay  204 ms
> loop  21 delay  203 ms
> loop  22 delay  208 ms
> loop  23 delay  200 ms
> loop  24 delay  203 ms
> loop  25 delay  203 ms
> loop  26 delay  204 ms
> loop  27 delay  204 ms
> loop  28 delay  120 ms
> loop  29 delay   83 ms
> loop  30 delay  204 ms
> loop  31 delay  203 ms
> loop  32 delay  204 ms
> loop  33 delay  208 ms
> loop  34 delay  199 ms
> loop  35 delay  204 ms
> loop  36 delay  175 ms
> loop  37 delay   11 ms
> loop  38 delay  115 ms
> loop  39 delay  205 ms
> loop  40 delay  204 ms
> loop  41 delay   11 ms
> loop  42 delay   91 ms
> loop  43 delay  202 ms
> loop  44 delay  203 ms
> loop  45 delay  204 ms
> loop  46 delay  209 ms
> loop  47 delay  112 ms
> loop  48 delay   16 ms
> loop  49 delay   69 ms
> loop  50 delay  204 ms
> loop  51 delay   18 ms
> loop  52 delay   14 ms
> loop  53 delay   70 ms
> loop  54 delay   33 ms
> loop  55 delay  184 ms
> loop  56 delay  199 ms
> loop  57 delay  194 ms
> loop  58 delay  102 ms
> loop  59 delay  102 ms
> loop  60 delay   12 ms
> loop  61 delay  197 ms
> loop  62 delay  204 ms
> loop  63 delay  204 ms
> loop  64 delay  206 ms
> loop  65 delay   11 ms
> loop  66 delay  180 ms
> loop  67 delay  202 ms
> loop  68 delay   10 ms
> loop  69 delay   20 ms
> loop  70 delay  199 ms
> loop  71 delay  179 ms
> loop  72 delay  202 ms
> loop  73 delay   33 ms
> loop  74 delay   69 ms
> loop  75 delay   14 ms
> loop  76 delay   88 ms
> loop  77 delay  204 ms
> loop  78 delay  209 ms
> loop  79 delay  198 ms
> loop  80 delay  204 ms
> loop  81 delay   25 ms
> loop  82 delay   76 ms
> loop  83 delay  102 ms
> loop  84 delay  173 ms
> loop  85 delay   13 ms
> loop  86 delay   17 ms
> loop  87 delay   14 ms
> loop  88 delay  191 ms
> loop  89 delay  204 ms
> loop  90 delay  204 ms
> loop  91 delay  102 ms
> loop  92 delay   47 ms
> loop  93 delay   37 ms
> loop  94 delay  142 ms
> loop  95 delay  202 ms
> loop  96 delay  204 ms
> loop  97 delay  202 ms
> loop  98 delay  104 ms
> loop  99 delay   80 ms
> total time = 14193 ms
>
>
> ====== LINUX   RESULTS are as expected ======
>
> sh -c '/opt/jdk/bin/java -cp ./mach5-mesos-support-1.0-SNAPSHOT.jar
> SleepLatency'
> Forked command at 6125
> loop   0 delay   10 ms
> loop   1 delay   11 ms
> loop   2 delay   10 ms
> loop   3 delay   10 ms
> loop   4 delay   10 ms
> loop   5 delay   10 ms
> loop   6 delay   10 ms
> loop   7 delay   10 ms
> loop   8 delay   10 ms
> loop   9 delay   10 ms
> loop  10 delay   10 ms
> loop  11 delay   10 ms
> loop  12 delay   10 ms
> loop  13 delay   10 ms
> loop  14 delay   10 ms
> loop  15 delay   10 ms
> loop  16 delay   10 ms
> loop  17 delay   10 ms
> loop  18 delay   10 ms
> loop  19 delay   11 ms
> loop  20 delay   10 ms
> loop  21 delay   10 ms
> loop  22 delay   10 ms
> loop  23 delay   10 ms
> loop  24 delay   10 ms
> loop  25 delay   11 ms
> loop  26 delay   10 ms
> loop  27 delay   10 ms
> loop  28 delay   10 ms
> loop  29 delay   10 ms
> loop  30 delay   10 ms
> loop  31 delay   10 ms
> loop  32 delay   10 ms
> loop  33 delay   10 ms
> loop  34 delay   11 ms
> loop  35 delay   10 ms
> loop  36 delay   10 ms
> loop  37 delay   11 ms
> loop  38 delay   10 ms
> loop  39 delay   10 ms
> loop  40 delay   11 ms
> loop  41 delay   10 ms
> loop  42 delay   10 ms
> loop  43 delay   11 ms
> loop  44 delay   10 ms
> loop  45 delay   10 ms
> loop  46 delay   10 ms
> loop  47 delay   10 ms
> loop  48 delay   10 ms
> loop  49 delay   10 ms
> loop  50 delay   10 ms
> loop  51 delay   10 ms
> loop  52 delay   11 ms
> loop  53 delay   10 ms
> loop  54 delay   10 ms
> loop  55 delay   10 ms
> loop  56 delay   10 ms
> loop  57 delay   10 ms
> loop  58 delay   10 ms
> loop  59 delay   10 ms
> loop  60 delay   10 ms
> loop  61 delay   10 ms
> loop  62 delay   11 ms
> loop  63 delay   10 ms
> loop  64 delay   10 ms
> loop  65 delay   11 ms
> loop  66 delay   10 ms
> loop  67 delay   10 ms
> loop  68 delay   10 ms
> loop  69 delay   10 ms
> loop  70 delay   10 ms
> loop  71 delay   10 ms
> loop  72 delay   11 ms
> loop  73 delay   10 ms
> loop  74 delay   10 ms
> loop  75 delay   10 ms
> loop  76 delay   11 ms
> loop  77 delay   10 ms
> loop  78 delay   10 ms
> loop  79 delay   10 ms
> loop  80 delay   11 ms
> loop  81 delay   10 ms
> loop  82 delay   10 ms
> loop  83 delay   10 ms
> loop  84 delay   10 ms
> loop  85 delay   10 ms
> loop  86 delay   10 ms
> loop  87 delay   10 ms
> loop  88 delay   10 ms
> loop  89 delay   10 ms
> loop  90 delay   10 ms
> loop  91 delay   10 ms
> loop  92 delay   10 ms
> loop  93 delay   10 ms
> loop  94 delay   10 ms
> loop  95 delay   10 ms
> loop  96 delay   10 ms
> loop  97 delay   10 ms
> loop  98 delay   10 ms
> loop  99 delay   10 ms
> total time =  1035 ms
>
>
>
>


-- 
Best Regards,
Haosdent Huang