builder: mozilla-central_ubuntu64_hw_stylo_test-dromaeojs-e10s slave: talos-linux64-ix-057 starttime: 1501063220.59 results: success (0) revision: e8400551c2e39f24c75a009ebed496c7acd7bf47 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2017-07-26 03:00:20.589948) ========= master: http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2017-07-26 03:00:20.590687) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-07-26 03:00:20.590978) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-07-26 03:00:20.649232) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-07-26 03:00:20.649740) ========= bash -c 'wget -Oarchiver_client.py --no-check-certificate --tries=10 --waitretry=3 https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'wget -Oarchiver_client.py --no-check-certificate --tries=10 --waitretry=3 https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=934fc3100db09dcb9af4d4b6000001ab-1501060803.338282-617044629 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2017-07-26 03:00:20-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.25, 63.245.215.102 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.25|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12179 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 69.1M=0s 2017-07-26 03:00:21 (69.1 MB/s) - `archiver_client.py' saved [12179/12179] program finished with exit code 0 elapsedTime=0.135267 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-07-26 03:00:20.799855) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-07-26 03:00:20.800236) ========= rm -rf scripts properties in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-rf', 'scripts', 'properties'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=934fc3100db09dcb9af4d4b6000001ab-1501060803.338282-617044629 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.019917 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-07-26 03:00:20.850753) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-07-26 03:00:20.851169) ========= bash -c 'python archiver_client.py mozharness --repo mozilla-central --rev e8400551c2e39f24c75a009ebed496c7acd7bf47 --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'python archiver_client.py mozharness --repo mozilla-central --rev e8400551c2e39f24c75a009ebed496c7acd7bf47 --destination scripts --debug'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=934fc3100db09dcb9af4d4b6000001ab-1501060803.338282-617044629 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2017-07-26 03:00:21,166 truncating revision to first 12 chars 2017-07-26 03:00:21,166 Setting DEBUG logging. 2017-07-26 03:00:21,166 attempt 1/10 2017-07-26 03:00:21,166 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/mozilla-central/e8400551c2e3?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2017-07-26 03:00:21,794 unpacking tar archive at: mozilla-central-e8400551c2e3/testing/mozharness/ program finished with exit code 0 elapsedTime=0.970953 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-07-26 03:00:21.835402) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-07-26 03:00:21.835743) ========= script_repo_revision: e8400551c2e39f24c75a009ebed496c7acd7bf47 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-07-26 03:00:21.836152) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-07-26 03:00:21.836658) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-07-26 03:00:21.846021) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 53 secs) (at 2017-07-26 03:00:21.846956) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Firefox --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs-e10s', '--add-option', '--webServer,localhost', '--branch-name', 'Firefox', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Firefox'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PROPERTIES_FILE=/builds/slave/test/buildprops.json PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=934fc3100db09dcb9af4d4b6000001ab-1501060803.338282-617044629 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 03:00:22 INFO - MultiFileLogger online at 20170726 03:00:22 in /builds/slave/test 03:00:22 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Firefox --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox 03:00:22 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 03:00:22 INFO - {'append_to_log': False, 03:00:22 INFO - 'base_work_dir': '/builds/slave/test', 03:00:22 INFO - 'blob_upload_branch': 'Firefox', 03:00:22 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 03:00:22 INFO - 'branch': 'Firefox', 03:00:22 INFO - 'buildbot_json_path': 'buildprops.json', 03:00:22 INFO - 'code_coverage': False, 03:00:22 INFO - 'config_files': ('talos/linux_config.py',), 03:00:22 INFO - 'default_actions': ('clobber', 03:00:22 INFO - 'read-buildbot-config', 03:00:22 INFO - 'download-and-extract', 03:00:22 INFO - 'populate-webroot', 03:00:22 INFO - 'create-virtualenv', 03:00:22 INFO - 'install', 03:00:22 INFO - 'setup-mitmproxy', 03:00:22 INFO - 'run-tests'), 03:00:22 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 03:00:22 INFO - 'disable_ccov_upload': False, 03:00:22 INFO - 'download_minidump_stackwalk': True, 03:00:22 INFO - 'download_symbols': 'ondemand', 03:00:22 INFO - 'enable_stylo': False, 03:00:22 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 03:00:22 INFO - 'tooltool.py': '/tools/tooltool.py', 03:00:22 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 03:00:22 INFO - '/tools/misc-python/virtualenv.py')}, 03:00:22 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 03:00:22 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 03:00:22 INFO - 'gecko_profile': False, 03:00:22 INFO - 'gecko_profile_interval': 0, 03:00:22 INFO - 'installer_path': 'installer.exe', 03:00:22 INFO - 'log_level': 'info', 03:00:22 INFO - 'log_name': 'talos', 03:00:22 INFO - 'log_to_console': True, 03:00:22 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 03:00:22 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 03:00:22 INFO - 'opt_config_files': (), 03:00:22 INFO - 'pip_index': False, 03:00:22 INFO - 'suite': 'dromaeojs-e10s', 03:00:22 INFO - 'system_bits': '32', 03:00:22 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 03:00:22 INFO - 'title': 'talos-linux64-ix-057', 03:00:22 INFO - 'tooltool_cache': '/builds/tooltool_cache', 03:00:22 INFO - 'use_talos_json': True, 03:00:22 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 03:00:22 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 03:00:22 INFO - 'work_dir': 'build'} 03:00:22 INFO - [mozharness: 2017-07-26 10:00:22.265944Z] Running clobber step. 03:00:22 INFO - Running pre-action listener: _resource_record_pre_action 03:00:22 INFO - Running main action method: clobber 03:00:22 INFO - rmtree: /builds/slave/test/build 03:00:22 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 03:00:23 INFO - Running post-action listener: _resource_record_post_action 03:00:23 INFO - [mozharness: 2017-07-26 10:00:23.285152Z] Finished clobber step (success) 03:00:23 INFO - [mozharness: 2017-07-26 10:00:23.285255Z] Running read-buildbot-config step. 03:00:23 INFO - Running pre-action listener: _resource_record_pre_action 03:00:23 INFO - Running main action method: read_buildbot_config 03:00:23 INFO - Using buildbot properties: 03:00:23 INFO - { 03:00:23 INFO - "project": "", 03:00:23 INFO - "product": "firefox", 03:00:23 INFO - "who": "cbook@mozilla.com", 03:00:23 INFO - "installer_path": "public/build/target.tar.bz2", 03:00:23 INFO - "builddir": "mozilla-central_ubuntu64_hw_stylo_test-dromaeojs-e10s", 03:00:23 INFO - "repository": "https://hg.mozilla.org/mozilla-central", 03:00:23 INFO - "buildername": "Ubuntu HW 12.04 x64 stylo mozilla-central talos dromaeojs-e10s", 03:00:23 INFO - "stage_platform": "linux64-stylo", 03:00:23 INFO - "basedir": "/builds/slave/test", 03:00:23 INFO - "buildnumber": 237, 03:00:23 INFO - "platform": "ubuntu64_hw_stylo", 03:00:23 INFO - "master": "http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/", 03:00:23 INFO - "slavebuilddir": "test", 03:00:23 INFO - "taskId": "ExwBB7rMR8-lwjYoxVM_uQ", 03:00:23 INFO - "branch": "mozilla-central", 03:00:23 INFO - "script_repo_revision": "production", 03:00:23 INFO - "revision": "e8400551c2e39f24c75a009ebed496c7acd7bf47", 03:00:23 INFO - "slavename": "talos-linux64-ix-057", 03:00:23 INFO - "repo_path": "mozilla-central" 03:00:23 INFO - } 03:00:23 INFO - Finding installer, test and symbols from parent task. 03:00:23 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/ExwBB7rMR8-lwjYoxVM_uQ'}, attempt #1 03:00:23 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/ExwBB7rMR8-lwjYoxVM_uQ'}, attempt #1 03:00:24 INFO - Task dependencies: IWL1hFHuQNKITtjZ11Me9g 03:00:24 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/IWL1hFHuQNKITtjZ11Me9g'}, attempt #1 03:00:24 INFO - Set installer_url: https://queue.taskcluster.net/v1/task/IWL1hFHuQNKITtjZ11Me9g/artifacts/public/build/target.tar.bz2 03:00:24 INFO - Set test_url: https://queue.taskcluster.net/v1/task/IWL1hFHuQNKITtjZ11Me9g/artifacts/public/build/test_packages.json 03:00:24 INFO - Set symbols_url: https://queue.taskcluster.net/v1/task/IWL1hFHuQNKITtjZ11Me9g/artifacts/public/build/target.crashreporter-symbols.zip 03:00:24 INFO - Running post-action listener: _resource_record_post_action 03:00:24 INFO - [mozharness: 2017-07-26 10:00:24.669834Z] Finished read-buildbot-config step (success) 03:00:24 INFO - [mozharness: 2017-07-26 10:00:24.670054Z] Running download-and-extract step. 03:00:24 INFO - Running pre-action listener: _resource_record_pre_action 03:00:24 INFO - Running main action method: download_and_extract 03:00:24 INFO - mkdir: /builds/slave/test/build/tests 03:00:24 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:00:24 INFO - trying https://queue.taskcluster.net/v1/task/IWL1hFHuQNKITtjZ11Me9g/artifacts/public/build/target.test_packages.json 03:00:24 INFO - Downloading https://queue.taskcluster.net/v1/task/IWL1hFHuQNKITtjZ11Me9g/artifacts/public/build/target.test_packages.json to /builds/slave/test/build/target.test_packages.json 03:00:24 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/IWL1hFHuQNKITtjZ11Me9g/artifacts/public/build/target.test_packages.json', 'file_name': '/builds/slave/test/build/target.test_packages.json'}, attempt #1 03:00:25 INFO - Downloaded 989 bytes. 03:00:25 INFO - Reading from file /builds/slave/test/build/target.test_packages.json 03:00:25 INFO - Using the following test package requirements: 03:00:25 INFO - {u'awsy': [u'target.common.tests.zip', u'target.awsy.tests.zip'], 03:00:25 INFO - u'common': [u'target.common.tests.zip'], 03:00:25 INFO - u'cppunittest': [u'target.common.tests.zip', u'target.cppunittest.tests.zip'], 03:00:25 INFO - u'gtest': [u'target.common.tests.zip', u'target.gtest.tests.zip'], 03:00:25 INFO - u'jittest': [u'target.common.tests.zip', u'target.jsshell.zip'], 03:00:25 INFO - u'mochitest': [u'target.common.tests.zip', u'target.mochitest.tests.zip'], 03:00:25 INFO - u'mozbase': [u'target.common.tests.zip'], 03:00:25 INFO - u'reftest': [u'target.common.tests.zip', u'target.reftest.tests.zip'], 03:00:25 INFO - u'talos': [u'target.common.tests.zip', u'target.talos.tests.zip'], 03:00:25 INFO - u'web-platform': [u'target.common.tests.zip', 03:00:25 INFO - u'target.web-platform.tests.tar.gz'], 03:00:25 INFO - u'xpcshell': [u'target.common.tests.zip', u'target.xpcshell.tests.zip']} 03:00:25 INFO - Downloading packages: [u'target.common.tests.zip'] for test suite category: common 03:00:25 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/IWL1hFHuQNKITtjZ11Me9g/artifacts/public/build/target.common.tests.zip 03:00:25 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/IWL1hFHuQNKITtjZ11Me9g/artifacts/public/build/target.common.tests.zip'}, attempt #1 03:00:25 INFO - Fetch https://queue.taskcluster.net/v1/task/IWL1hFHuQNKITtjZ11Me9g/artifacts/public/build/target.common.tests.zip into memory 03:00:26 INFO - Content-Length response header: 72522450 03:00:26 INFO - Bytes received: 72522450 03:00:37 INFO - Downloading packages: [u'target.common.tests.zip', u'target.talos.tests.zip'] for test suite category: talos 03:00:37 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/IWL1hFHuQNKITtjZ11Me9g/artifacts/public/build/target.common.tests.zip 03:00:37 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/IWL1hFHuQNKITtjZ11Me9g/artifacts/public/build/target.common.tests.zip'}, attempt #1 03:00:37 INFO - Fetch https://queue.taskcluster.net/v1/task/IWL1hFHuQNKITtjZ11Me9g/artifacts/public/build/target.common.tests.zip into memory 03:00:39 INFO - Content-Length response header: 72522450 03:00:39 INFO - Bytes received: 72522450 03:00:51 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/IWL1hFHuQNKITtjZ11Me9g/artifacts/public/build/target.talos.tests.zip 03:00:51 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/IWL1hFHuQNKITtjZ11Me9g/artifacts/public/build/target.talos.tests.zip'}, attempt #1 03:00:51 INFO - Fetch https://queue.taskcluster.net/v1/task/IWL1hFHuQNKITtjZ11Me9g/artifacts/public/build/target.talos.tests.zip into memory 03:00:51 INFO - Content-Length response header: 14496448 03:00:51 INFO - Bytes received: 14496448 03:00:52 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:00:52 INFO - trying https://queue.taskcluster.net/v1/task/IWL1hFHuQNKITtjZ11Me9g/artifacts/public/build/target.tar.bz2 03:00:52 INFO - Downloading https://queue.taskcluster.net/v1/task/IWL1hFHuQNKITtjZ11Me9g/artifacts/public/build/target.tar.bz2 to /builds/slave/test/build/target.tar.bz2 03:00:52 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/IWL1hFHuQNKITtjZ11Me9g/artifacts/public/build/target.tar.bz2', 'file_name': '/builds/slave/test/build/target.tar.bz2'}, attempt #1 03:00:53 INFO - Downloaded 62104218 bytes. 03:00:53 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/IWL1hFHuQNKITtjZ11Me9g/artifacts/public/build/target.tar.bz2 03:00:53 INFO - mkdir: /builds/slave/test/properties 03:00:53 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 03:00:53 INFO - Writing to file /builds/slave/test/properties/build_url 03:00:53 INFO - Contents: 03:00:53 INFO - build_url:https://queue.taskcluster.net/v1/task/IWL1hFHuQNKITtjZ11Me9g/artifacts/public/build/target.tar.bz2 03:00:53 INFO - Running post-action listener: _resource_record_post_action 03:00:53 INFO - Running post-action listener: set_extra_try_arguments 03:00:53 INFO - [mozharness: 2017-07-26 10:00:53.322411Z] Finished download-and-extract step (success) 03:00:53 INFO - [mozharness: 2017-07-26 10:00:53.322509Z] Running populate-webroot step. 03:00:53 INFO - Running pre-action listener: _resource_record_pre_action 03:00:53 INFO - Running main action method: populate_webroot 03:00:53 INFO - {'suites': {'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 03:00:53 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 03:00:53 INFO - 'g1-e10s': {'pagesets_name': 'tp5n.zip', 03:00:53 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 03:00:53 INFO - 'g2-e10s': {'pagesets_name': 'tp5n.zip', 03:00:53 INFO - 'tests': ['damp', 'tps']}, 03:00:53 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 03:00:53 INFO - 'g4-e10s': {'tests': ['basic_compositor_video', 'glvideo']}, 03:00:53 INFO - 'g5-e10s': {'pagesets_name': 'tp5n.zip', 03:00:53 INFO - 'tests': ['ts_paint_webext', 'tp5o_webext']}, 03:00:53 INFO - 'other-e10s': {'tests': ['a11yr', 03:00:53 INFO - 'ts_paint', 03:00:53 INFO - 'tpaint', 03:00:53 INFO - 'sessionrestore', 03:00:53 INFO - 'sessionrestore_many_windows', 03:00:53 INFO - 'sessionrestore_no_auto_restore', 03:00:53 INFO - 'tabpaint']}, 03:00:53 INFO - 'perf-reftest-e10s': {'tests': ['bloom_basic']}, 03:00:53 INFO - 'perf-reftest-singletons-e10s': {'tests': ['bloom_basic_singleton']}, 03:00:53 INFO - 'quantum-pageload-e10s': {'mitmproxy_recording_set': 'mitmproxy-recording-set-win10.zip', 03:00:53 INFO - 'talos_options': ['--mitmproxy', 03:00:53 INFO - 'mitmproxy-recording-google.mp mitmproxy-recording-youtube.mp mitmproxy-recording-amazon.mp mitmproxy-recording-facebook.mp', 03:00:53 INFO - '--firstNonBlankPaint'], 03:00:53 INFO - 'tests': ['quantum_pageload_google', 03:00:53 INFO - 'quantum_pageload_youtube', 03:00:53 INFO - 'quantum_pageload_amazon', 03:00:53 INFO - 'quantum_pageload_facebook']}, 03:00:53 INFO - 'quantum-pageload-stylo-e10s': {'mitmproxy_recording_set': 'mitmproxy-recording-set-win10.zip', 03:00:53 INFO - 'talos_options': ['--stylo', 03:00:53 INFO - '--mitmproxy', 03:00:53 INFO - 'mitmproxy-recording-google.mp mitmproxy-recording-youtube.mp mitmproxy-recording-amazon.mp mitmproxy-recording-facebook.mp', 03:00:53 INFO - '--firstNonBlankPaint'], 03:00:53 INFO - 'tests': ['quantum_pageload_google', 03:00:53 INFO - 'quantum_pageload_youtube', 03:00:53 INFO - 'quantum_pageload_amazon', 03:00:53 INFO - 'quantum_pageload_facebook']}, 03:00:53 INFO - 'svgr-e10s': {'tests': ['tsvgx', 03:00:53 INFO - 'tsvgr_opacity', 03:00:53 INFO - 'tart', 03:00:53 INFO - 'tscrollx', 03:00:53 INFO - 'cart', 03:00:53 INFO - 'tsvg_static']}, 03:00:53 INFO - 'tp5o-e10s': {'pagesets_name': 'tp5n.zip', 'tests': ['tp5o']}, 03:00:53 INFO - 'xperf-e10s': {'pagesets_name': 'tp5n.zip', 03:00:53 INFO - 'talos_options': ['--xperf_path', 03:00:53 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 03:00:53 INFO - 'tests': ['tp5n']}}} 03:00:53 INFO - Running post-action listener: _resource_record_post_action 03:00:53 INFO - [mozharness: 2017-07-26 10:00:53.329785Z] Finished populate-webroot step (success) 03:00:53 INFO - [mozharness: 2017-07-26 10:00:53.329874Z] Running create-virtualenv step. 03:00:53 INFO - Running pre-action listener: _resource_record_pre_action 03:00:53 INFO - Running main action method: create_virtualenv 03:00:53 INFO - Creating virtualenv /builds/slave/test/build/venv 03:00:53 INFO - Running command: ['/tools/buildbot/bin/python', '/tools/misc-python/virtualenv.py', '--no-site-packages', '--distribute', '/builds/slave/test/build/venv'] in /builds/slave/test/build 03:00:53 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 03:00:53 INFO - Using partial env: {'VIRTUALENV_NO_DOWNLOAD': '1'} 03:00:53 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 03:00:53 INFO - Using real prefix '/usr' 03:00:53 INFO - New python executable in /builds/slave/test/build/venv/bin/python 03:00:53 INFO - Installing distribute.............................................................................................................................................................................................done. 03:00:55 INFO - Installing pip.................done. 03:00:55 INFO - Return code: 0 03:00:55 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', '--version'] 03:00:55 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip --version 03:00:56 INFO - Reading from file tmpfile_stdout 03:00:56 INFO - Output received: 03:00:56 INFO - pip 1.5.5 from /builds/slave/test/build/venv/local/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg (python 2.7) 03:00:56 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 03:00:56 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:00:56 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:00:56 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:00:56 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:00:56 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x28981f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2a64a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2c07d10>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2c04eb0>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2c05db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2c06240>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '934fc3100db09dcb9af4d4b6000001ab-1501060803.338282-617044629', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 03:00:56 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5'] in /builds/slave/test/build 03:00:56 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub pip>=1.5 03:00:56 INFO - Using env: {'DISPLAY': ':0', 03:00:56 INFO - 'HOME': '/home/cltbld', 03:00:56 INFO - 'LANG': 'en_US.UTF-8', 03:00:56 INFO - 'LANGUAGE': 'en_US:en', 03:00:56 INFO - 'LOGNAME': 'cltbld', 03:00:56 INFO - 'MAIL': '/var/mail/cltbld', 03:00:56 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:00:56 INFO - 'MOZ_NO_REMOTE': '1', 03:00:56 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:00:56 INFO - 'NO_EM_RESTART': '1', 03:00:56 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:00:56 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:00:56 INFO - 'PWD': '/builds/slave/test', 03:00:56 INFO - 'SHELL': '/bin/bash', 03:00:56 INFO - 'SHLVL': '1', 03:00:56 INFO - 'TERM': 'linux', 03:00:56 INFO - 'TMOUT': '86400', 03:00:56 INFO - 'USER': 'cltbld', 03:00:56 INFO - 'XDG_SESSION_COOKIE': '934fc3100db09dcb9af4d4b6000001ab-1501060803.338282-617044629', 03:00:56 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:00:56 INFO - '_': '/tools/buildbot/bin/python'} 03:00:56 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:00:56 INFO - Requirement already satisfied (use --upgrade to upgrade): pip>=1.5 in ./venv/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg 03:00:56 INFO - Cleaning up... 03:00:56 INFO - Return code: 0 03:00:56 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 03:00:56 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:00:56 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:00:56 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:00:56 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:00:56 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=3.1.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x28981f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2a64a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2c07d10>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2c04eb0>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2c05db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2c06240>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '934fc3100db09dcb9af4d4b6000001ab-1501060803.338282-617044629', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 03:00:56 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=3.1.1'] in /builds/slave/test/build 03:00:56 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=3.1.1 03:00:56 INFO - Using env: {'DISPLAY': ':0', 03:00:56 INFO - 'HOME': '/home/cltbld', 03:00:56 INFO - 'LANG': 'en_US.UTF-8', 03:00:56 INFO - 'LANGUAGE': 'en_US:en', 03:00:56 INFO - 'LOGNAME': 'cltbld', 03:00:56 INFO - 'MAIL': '/var/mail/cltbld', 03:00:56 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:00:56 INFO - 'MOZ_NO_REMOTE': '1', 03:00:56 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:00:56 INFO - 'NO_EM_RESTART': '1', 03:00:56 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:00:56 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:00:56 INFO - 'PWD': '/builds/slave/test', 03:00:56 INFO - 'SHELL': '/bin/bash', 03:00:56 INFO - 'SHLVL': '1', 03:00:56 INFO - 'TERM': 'linux', 03:00:56 INFO - 'TMOUT': '86400', 03:00:56 INFO - 'USER': 'cltbld', 03:00:56 INFO - 'XDG_SESSION_COOKIE': '934fc3100db09dcb9af4d4b6000001ab-1501060803.338282-617044629', 03:00:56 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:00:56 INFO - '_': '/tools/buildbot/bin/python'} 03:00:56 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:00:56 INFO - Downloading/unpacking psutil>=3.1.1 03:00:56 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:00:56 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:00:56 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:00:56 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:00:57 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 03:00:57 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 03:00:57 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 03:00:57 INFO - Installing collected packages: psutil 03:00:57 INFO - Running setup.py install for psutil 03:00:57 INFO - building 'psutil._psutil_linux' extension 03:00:57 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -DPSUTIL_VERSION=311 -I/usr/include/python2.7 -c psutil/_psutil_linux.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o 03:00:57 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_linux.so 03:00:57 INFO - building 'psutil._psutil_posix' extension 03:00:58 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -I/usr/include/python2.7 -c psutil/_psutil_posix.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o 03:00:58 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_posix.so 03:00:58 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 03:00:58 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 03:00:58 INFO - Successfully installed psutil 03:00:58 INFO - Cleaning up... 03:00:58 INFO - Return code: 0 03:00:58 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 03:00:58 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:00:58 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:00:58 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:00:58 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:00:58 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.3']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x28981f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2a64a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2c07d10>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2c04eb0>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2c05db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2c06240>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '934fc3100db09dcb9af4d4b6000001ab-1501060803.338282-617044629', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 03:00:58 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.3'] in /builds/slave/test/build 03:00:58 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.3 03:00:58 INFO - Using env: {'DISPLAY': ':0', 03:00:58 INFO - 'HOME': '/home/cltbld', 03:00:58 INFO - 'LANG': 'en_US.UTF-8', 03:00:58 INFO - 'LANGUAGE': 'en_US:en', 03:00:58 INFO - 'LOGNAME': 'cltbld', 03:00:58 INFO - 'MAIL': '/var/mail/cltbld', 03:00:58 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:00:58 INFO - 'MOZ_NO_REMOTE': '1', 03:00:58 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:00:58 INFO - 'NO_EM_RESTART': '1', 03:00:58 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:00:58 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:00:58 INFO - 'PWD': '/builds/slave/test', 03:00:58 INFO - 'SHELL': '/bin/bash', 03:00:58 INFO - 'SHLVL': '1', 03:00:58 INFO - 'TERM': 'linux', 03:00:58 INFO - 'TMOUT': '86400', 03:00:58 INFO - 'USER': 'cltbld', 03:00:58 INFO - 'XDG_SESSION_COOKIE': '934fc3100db09dcb9af4d4b6000001ab-1501060803.338282-617044629', 03:00:58 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:00:58 INFO - '_': '/tools/buildbot/bin/python'} 03:00:58 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:00:58 INFO - Downloading/unpacking mozsystemmonitor==0.3 03:00:58 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:00:58 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:00:58 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:00:58 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:00:59 INFO - Downloading mozsystemmonitor-0.3.tar.gz 03:00:59 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 03:00:59 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 03:00:59 INFO - Installing collected packages: mozsystemmonitor 03:00:59 INFO - Running setup.py install for mozsystemmonitor 03:00:59 INFO - Successfully installed mozsystemmonitor 03:00:59 INFO - Cleaning up... 03:00:59 INFO - Return code: 0 03:00:59 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 03:00:59 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:00:59 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:00:59 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:00:59 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:00:59 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema==2.5.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x28981f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2a64a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2c07d10>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2c04eb0>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2c05db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2c06240>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '934fc3100db09dcb9af4d4b6000001ab-1501060803.338282-617044629', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 03:00:59 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema==2.5.1'] in /builds/slave/test/build 03:00:59 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema==2.5.1 03:00:59 INFO - Using env: {'DISPLAY': ':0', 03:00:59 INFO - 'HOME': '/home/cltbld', 03:00:59 INFO - 'LANG': 'en_US.UTF-8', 03:00:59 INFO - 'LANGUAGE': 'en_US:en', 03:00:59 INFO - 'LOGNAME': 'cltbld', 03:00:59 INFO - 'MAIL': '/var/mail/cltbld', 03:00:59 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:00:59 INFO - 'MOZ_NO_REMOTE': '1', 03:00:59 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:00:59 INFO - 'NO_EM_RESTART': '1', 03:00:59 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:00:59 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:00:59 INFO - 'PWD': '/builds/slave/test', 03:00:59 INFO - 'SHELL': '/bin/bash', 03:00:59 INFO - 'SHLVL': '1', 03:00:59 INFO - 'TERM': 'linux', 03:00:59 INFO - 'TMOUT': '86400', 03:00:59 INFO - 'USER': 'cltbld', 03:00:59 INFO - 'XDG_SESSION_COOKIE': '934fc3100db09dcb9af4d4b6000001ab-1501060803.338282-617044629', 03:00:59 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:00:59 INFO - '_': '/tools/buildbot/bin/python'} 03:00:59 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:00:59 INFO - Downloading/unpacking jsonschema==2.5.1 03:00:59 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:00:59 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:00:59 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:00:59 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:01:01 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 03:01:01 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 03:01:01 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:01:01 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:01:01 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:01:01 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:01:01 INFO - Downloading functools32-3.2.3-2.tar.gz 03:01:01 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 03:01:01 INFO - warning: no files found matching '*.txt' 03:01:01 INFO - no previously-included directories found matching 'build' 03:01:01 INFO - no previously-included directories found matching 'dist' 03:01:01 INFO - no previously-included directories found matching '.git*' 03:01:01 INFO - Installing collected packages: jsonschema, functools32 03:01:01 INFO - Running setup.py install for functools32 03:01:01 INFO - warning: no files found matching '*.txt' 03:01:01 INFO - no previously-included directories found matching 'build' 03:01:01 INFO - no previously-included directories found matching 'dist' 03:01:01 INFO - no previously-included directories found matching '.git*' 03:01:01 INFO - Successfully installed jsonschema functools32 03:01:01 INFO - Cleaning up... 03:01:01 INFO - Return code: 0 03:01:01 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 03:01:01 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:01:01 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:01:01 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:01:01 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:01:01 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'functools32==3.2.3-2']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x28981f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2a64a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2c07d10>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2c04eb0>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2c05db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2c06240>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '934fc3100db09dcb9af4d4b6000001ab-1501060803.338282-617044629', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 03:01:01 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'functools32==3.2.3-2'] in /builds/slave/test/build 03:01:01 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub functools32==3.2.3-2 03:01:01 INFO - Using env: {'DISPLAY': ':0', 03:01:01 INFO - 'HOME': '/home/cltbld', 03:01:01 INFO - 'LANG': 'en_US.UTF-8', 03:01:01 INFO - 'LANGUAGE': 'en_US:en', 03:01:01 INFO - 'LOGNAME': 'cltbld', 03:01:01 INFO - 'MAIL': '/var/mail/cltbld', 03:01:01 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:01:01 INFO - 'MOZ_NO_REMOTE': '1', 03:01:01 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:01:01 INFO - 'NO_EM_RESTART': '1', 03:01:01 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:01:01 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:01:01 INFO - 'PWD': '/builds/slave/test', 03:01:01 INFO - 'SHELL': '/bin/bash', 03:01:01 INFO - 'SHLVL': '1', 03:01:01 INFO - 'TERM': 'linux', 03:01:01 INFO - 'TMOUT': '86400', 03:01:01 INFO - 'USER': 'cltbld', 03:01:01 INFO - 'XDG_SESSION_COOKIE': '934fc3100db09dcb9af4d4b6000001ab-1501060803.338282-617044629', 03:01:01 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:01:01 INFO - '_': '/tools/buildbot/bin/python'} 03:01:01 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:01:01 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 03:01:01 INFO - Cleaning up... 03:01:01 INFO - Return code: 0 03:01:01 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 03:01:01 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:01:01 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:01:01 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:01:01 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:01:01 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x28981f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2a64a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2c07d10>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2c04eb0>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2c05db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2c06240>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '934fc3100db09dcb9af4d4b6000001ab-1501060803.338282-617044629', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 03:01:01 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4'] in /builds/slave/test/build 03:01:01 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 03:01:01 INFO - Using env: {'DISPLAY': ':0', 03:01:01 INFO - 'HOME': '/home/cltbld', 03:01:01 INFO - 'LANG': 'en_US.UTF-8', 03:01:01 INFO - 'LANGUAGE': 'en_US:en', 03:01:01 INFO - 'LOGNAME': 'cltbld', 03:01:01 INFO - 'MAIL': '/var/mail/cltbld', 03:01:01 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:01:01 INFO - 'MOZ_NO_REMOTE': '1', 03:01:01 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:01:01 INFO - 'NO_EM_RESTART': '1', 03:01:01 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:01:01 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:01:01 INFO - 'PWD': '/builds/slave/test', 03:01:01 INFO - 'SHELL': '/bin/bash', 03:01:01 INFO - 'SHLVL': '1', 03:01:01 INFO - 'TERM': 'linux', 03:01:01 INFO - 'TMOUT': '86400', 03:01:01 INFO - 'USER': 'cltbld', 03:01:01 INFO - 'XDG_SESSION_COOKIE': '934fc3100db09dcb9af4d4b6000001ab-1501060803.338282-617044629', 03:01:01 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:01:01 INFO - '_': '/tools/buildbot/bin/python'} 03:01:01 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:01:01 INFO - Downloading/unpacking blobuploader==1.2.4 03:01:01 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:01:01 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:01:01 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:01:01 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:01:02 INFO - Downloading blobuploader-1.2.4.tar.gz 03:01:02 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 03:01:03 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 03:01:03 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:01:03 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:01:03 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:01:03 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:01:03 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 03:01:03 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 03:01:03 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:01:03 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:01:03 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:01:03 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:01:03 INFO - Downloading docopt-0.6.1.tar.gz 03:01:03 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 03:01:03 INFO - Installing collected packages: blobuploader, requests, docopt 03:01:03 INFO - Running setup.py install for blobuploader 03:01:03 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 03:01:03 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 03:01:03 INFO - Running setup.py install for requests 03:01:04 INFO - Running setup.py install for docopt 03:01:04 INFO - Successfully installed blobuploader requests docopt 03:01:04 INFO - Cleaning up... 03:01:04 INFO - Return code: 0 03:01:04 INFO - Installing None into virtualenv /builds/slave/test/build/venv 03:01:04 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:01:04 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:01:04 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:01:04 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:01:04 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x28981f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2a64a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2c07d10>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2c04eb0>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2c05db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2c06240>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '934fc3100db09dcb9af4d4b6000001ab-1501060803.338282-617044629', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 03:01:04 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 03:01:04 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --no-deps --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 03:01:04 INFO - Using env: {'DISPLAY': ':0', 03:01:04 INFO - 'HOME': '/home/cltbld', 03:01:04 INFO - 'LANG': 'en_US.UTF-8', 03:01:04 INFO - 'LANGUAGE': 'en_US:en', 03:01:04 INFO - 'LOGNAME': 'cltbld', 03:01:04 INFO - 'MAIL': '/var/mail/cltbld', 03:01:04 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:01:04 INFO - 'MOZ_NO_REMOTE': '1', 03:01:04 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:01:04 INFO - 'NO_EM_RESTART': '1', 03:01:04 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:01:04 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:01:04 INFO - 'PWD': '/builds/slave/test', 03:01:04 INFO - 'SHELL': '/bin/bash', 03:01:04 INFO - 'SHLVL': '1', 03:01:04 INFO - 'TERM': 'linux', 03:01:04 INFO - 'TMOUT': '86400', 03:01:04 INFO - 'USER': 'cltbld', 03:01:04 INFO - 'XDG_SESSION_COOKIE': '934fc3100db09dcb9af4d4b6000001ab-1501060803.338282-617044629', 03:01:04 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:01:04 INFO - '_': '/tools/buildbot/bin/python'} 03:01:04 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:01:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 03:01:04 INFO - Running setup.py (path:/tmp/pip-mzz5lf-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 03:01:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 03:01:04 INFO - Running setup.py (path:/tmp/pip-soE_MG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 03:01:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 03:01:04 INFO - Running setup.py (path:/tmp/pip-WgeqLP-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 03:01:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 03:01:04 INFO - Running setup.py (path:/tmp/pip-ANmwnx-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 03:01:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 03:01:04 INFO - Running setup.py (path:/tmp/pip-zTRJyj-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 03:01:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 03:01:04 INFO - Running setup.py (path:/tmp/pip-fSDawQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 03:01:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 03:01:04 INFO - Running setup.py (path:/tmp/pip-PgnJW8-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 03:01:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 03:01:04 INFO - Running setup.py (path:/tmp/pip-5uq_KB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 03:01:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 03:01:04 INFO - Running setup.py (path:/tmp/pip-vLUW_6-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 03:01:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 03:01:05 INFO - Running setup.py (path:/tmp/pip-LKV0a1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 03:01:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 03:01:05 INFO - Running setup.py (path:/tmp/pip-JFYGX2-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 03:01:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 03:01:05 INFO - Running setup.py (path:/tmp/pip-ZxFDo4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 03:01:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 03:01:05 INFO - Running setup.py (path:/tmp/pip-qjqODA-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 03:01:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 03:01:05 INFO - Running setup.py (path:/tmp/pip-TtyspQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 03:01:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 03:01:05 INFO - Running setup.py (path:/tmp/pip-Aoailq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 03:01:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 03:01:05 INFO - Running setup.py (path:/tmp/pip-i0tf8d-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 03:01:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 03:01:05 INFO - Running setup.py (path:/tmp/pip-UDb7L2-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 03:01:05 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 03:01:05 INFO - Running setup.py install for manifestparser 03:01:05 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 03:01:05 INFO - Running setup.py install for mozcrash 03:01:05 INFO - Running setup.py install for mozdebug 03:01:05 INFO - Running setup.py install for mozdevice 03:01:05 INFO - Installing dm script to /builds/slave/test/build/venv/bin 03:01:06 INFO - Running setup.py install for mozfile 03:01:06 INFO - Running setup.py install for mozhttpd 03:01:06 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 03:01:06 INFO - Running setup.py install for mozinfo 03:01:06 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 03:01:06 INFO - Running setup.py install for mozInstall 03:01:06 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 03:01:06 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 03:01:06 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 03:01:06 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 03:01:06 INFO - Running setup.py install for mozleak 03:01:06 INFO - Running setup.py install for mozlog 03:01:06 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 03:01:06 INFO - Running setup.py install for moznetwork 03:01:06 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 03:01:06 INFO - Running setup.py install for mozprocess 03:01:06 INFO - Running setup.py install for mozprofile 03:01:06 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 03:01:06 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 03:01:06 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 03:01:06 INFO - Running setup.py install for mozrunner 03:01:07 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 03:01:07 INFO - Running setup.py install for mozscreenshot 03:01:07 INFO - Running setup.py install for moztest 03:01:07 INFO - Running setup.py install for mozversion 03:01:07 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 03:01:07 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 03:01:07 INFO - Cleaning up... 03:01:07 INFO - Return code: 0 03:01:07 INFO - Installing None into virtualenv /builds/slave/test/build/venv 03:01:07 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:01:07 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:01:07 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:01:07 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:01:07 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x28981f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2a64a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2c07d10>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2c04eb0>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2c05db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2c06240>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '934fc3100db09dcb9af4d4b6000001ab-1501060803.338282-617044629', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 03:01:07 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 03:01:07 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 03:01:07 INFO - Using env: {'DISPLAY': ':0', 03:01:07 INFO - 'HOME': '/home/cltbld', 03:01:07 INFO - 'LANG': 'en_US.UTF-8', 03:01:07 INFO - 'LANGUAGE': 'en_US:en', 03:01:07 INFO - 'LOGNAME': 'cltbld', 03:01:07 INFO - 'MAIL': '/var/mail/cltbld', 03:01:07 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:01:07 INFO - 'MOZ_NO_REMOTE': '1', 03:01:07 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:01:07 INFO - 'NO_EM_RESTART': '1', 03:01:07 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:01:07 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:01:07 INFO - 'PWD': '/builds/slave/test', 03:01:07 INFO - 'SHELL': '/bin/bash', 03:01:07 INFO - 'SHLVL': '1', 03:01:07 INFO - 'TERM': 'linux', 03:01:07 INFO - 'TMOUT': '86400', 03:01:07 INFO - 'USER': 'cltbld', 03:01:07 INFO - 'XDG_SESSION_COOKIE': '934fc3100db09dcb9af4d4b6000001ab-1501060803.338282-617044629', 03:01:07 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:01:07 INFO - '_': '/tools/buildbot/bin/python'} 03:01:07 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:01:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 03:01:07 INFO - Running setup.py (path:/tmp/pip-AJ9zYB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 03:01:07 INFO - Requirement already satisfied (use --upgrade to upgrade): manifestparser==1.1 from file:///builds/slave/test/build/tests/mozbase/manifestparser in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 1)) 03:01:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 03:01:07 INFO - Running setup.py (path:/tmp/pip-aU6rTe-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 03:01:07 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==1.0 from file:///builds/slave/test/build/tests/mozbase/mozcrash in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 03:01:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 03:01:07 INFO - Running setup.py (path:/tmp/pip-mHN_cB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 03:01:07 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdebug==0.1 from file:///builds/slave/test/build/tests/mozbase/mozdebug in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 03:01:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 03:01:07 INFO - Running setup.py (path:/tmp/pip-AkY2dn-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 03:01:07 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.51 from file:///builds/slave/test/build/tests/mozbase/mozdevice in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 03:01:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 03:01:07 INFO - Running setup.py (path:/tmp/pip-fw9T33-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 03:01:07 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile==1.2 from file:///builds/slave/test/build/tests/mozbase/mozfile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 5)) 03:01:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 03:01:07 INFO - Running setup.py (path:/tmp/pip-z2L5_S-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 03:01:08 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd==0.7 from file:///builds/slave/test/build/tests/mozbase/mozhttpd in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 6)) 03:01:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 03:01:08 INFO - Running setup.py (path:/tmp/pip-om4ISX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 03:01:08 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo==0.10 from file:///builds/slave/test/build/tests/mozbase/mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 7)) 03:01:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 03:01:08 INFO - Running setup.py (path:/tmp/pip-qnF2oy-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 03:01:08 INFO - Requirement already satisfied (use --upgrade to upgrade): mozInstall==1.13 from file:///builds/slave/test/build/tests/mozbase/mozinstall in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 8)) 03:01:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 03:01:08 INFO - Running setup.py (path:/tmp/pip-0BzjIZ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 03:01:08 INFO - Requirement already satisfied (use --upgrade to upgrade): mozleak==0.1 from file:///builds/slave/test/build/tests/mozbase/mozleak in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 9)) 03:01:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 03:01:08 INFO - Running setup.py (path:/tmp/pip-SkNoUQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 03:01:08 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.5 from file:///builds/slave/test/build/tests/mozbase/mozlog in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 03:01:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 03:01:08 INFO - Running setup.py (path:/tmp/pip-tud9DG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 03:01:08 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork==0.27 from file:///builds/slave/test/build/tests/mozbase/moznetwork in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 11)) 03:01:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 03:01:08 INFO - Running setup.py (path:/tmp/pip-PdEK1v-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 03:01:08 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.25 from file:///builds/slave/test/build/tests/mozbase/mozprocess in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 12)) 03:01:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 03:01:08 INFO - Running setup.py (path:/tmp/pip-PCJrdn-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 03:01:08 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile==0.28 from file:///builds/slave/test/build/tests/mozbase/mozprofile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 13)) 03:01:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 03:01:08 INFO - Running setup.py (path:/tmp/pip-44fmxV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 03:01:08 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.13 from file:///builds/slave/test/build/tests/mozbase/mozrunner in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 14)) 03:01:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 03:01:08 INFO - Running setup.py (path:/tmp/pip-5C8s3q-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 03:01:08 INFO - Requirement already satisfied (use --upgrade to upgrade): mozscreenshot==0.1 from file:///builds/slave/test/build/tests/mozbase/mozscreenshot in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 15)) 03:01:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 03:01:08 INFO - Running setup.py (path:/tmp/pip-nW6ZgI-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 03:01:08 INFO - Requirement already satisfied (use --upgrade to upgrade): moztest==0.8 from file:///builds/slave/test/build/tests/mozbase/moztest in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 16)) 03:01:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 03:01:08 INFO - Running setup.py (path:/tmp/pip-fDUlb9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 03:01:08 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion==1.4 from file:///builds/slave/test/build/tests/mozbase/mozversion in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 17)) 03:01:08 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==1.0->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 03:01:08 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==1.0->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 03:01:08 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdebug==0.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 03:01:08 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.51->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 03:01:08 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.19 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.51->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 03:01:08 INFO - Requirement already satisfied (use --upgrade to upgrade): requests in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozInstall==1.13->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 8)) 03:01:08 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.5->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 03:01:08 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:01:08 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:01:08 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:01:08 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:01:09 INFO - Downloading blessings-1.6.tar.gz 03:01:09 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 03:01:10 INFO - Installing collected packages: blessings 03:01:10 INFO - Running setup.py install for blessings 03:01:10 INFO - Successfully installed blessings 03:01:10 INFO - Cleaning up... 03:01:10 INFO - Return code: 0 03:01:10 INFO - Done creating virtualenv /builds/slave/test/build/venv. 03:01:10 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 03:01:10 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 03:01:10 INFO - Reading from file tmpfile_stdout 03:01:10 INFO - Current package versions: 03:01:10 INFO - argparse == 1.2.1 03:01:10 INFO - blessings == 1.6 03:01:10 INFO - blobuploader == 1.2.4 03:01:10 INFO - docopt == 0.6.1 03:01:10 INFO - functools32 == 3.2.3-2 03:01:10 INFO - jsonschema == 2.5.1 03:01:10 INFO - manifestparser == 1.1 03:01:10 INFO - mozInstall == 1.13 03:01:10 INFO - mozcrash == 1.0 03:01:10 INFO - mozdebug == 0.1 03:01:10 INFO - mozdevice == 0.51 03:01:10 INFO - mozfile == 1.2 03:01:10 INFO - mozhttpd == 0.7 03:01:10 INFO - mozinfo == 0.10 03:01:10 INFO - mozleak == 0.1 03:01:10 INFO - mozlog == 3.5 03:01:10 INFO - moznetwork == 0.27 03:01:10 INFO - mozprocess == 0.25 03:01:10 INFO - mozprofile == 0.28 03:01:10 INFO - mozrunner == 6.13 03:01:10 INFO - mozscreenshot == 0.1 03:01:10 INFO - mozsystemmonitor == 0.3 03:01:10 INFO - moztest == 0.8 03:01:10 INFO - mozversion == 1.4 03:01:10 INFO - psutil == 3.1.1 03:01:10 INFO - requests == 1.2.3 03:01:10 INFO - wsgiref == 0.1.2 03:01:10 INFO - Installing None into virtualenv /builds/slave/test/build/venv 03:01:10 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:01:10 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:01:10 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:01:10 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:01:10 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x28981f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2a64a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2c07d10>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2c04eb0>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2c05db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2c06240>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/talos', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '934fc3100db09dcb9af4d4b6000001ab-1501060803.338282-617044629', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 03:01:10 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/talos 03:01:10 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/talos/requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 03:01:10 INFO - Using env: {'DISPLAY': ':0', 03:01:10 INFO - 'HOME': '/home/cltbld', 03:01:10 INFO - 'LANG': 'en_US.UTF-8', 03:01:10 INFO - 'LANGUAGE': 'en_US:en', 03:01:10 INFO - 'LOGNAME': 'cltbld', 03:01:10 INFO - 'MAIL': '/var/mail/cltbld', 03:01:10 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:01:10 INFO - 'MOZ_NO_REMOTE': '1', 03:01:10 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:01:10 INFO - 'NO_EM_RESTART': '1', 03:01:10 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:01:10 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:01:10 INFO - 'PWD': '/builds/slave/test', 03:01:10 INFO - 'SHELL': '/bin/bash', 03:01:10 INFO - 'SHLVL': '1', 03:01:10 INFO - 'TERM': 'linux', 03:01:10 INFO - 'TMOUT': '86400', 03:01:10 INFO - 'USER': 'cltbld', 03:01:10 INFO - 'XDG_SESSION_COOKIE': '934fc3100db09dcb9af4d4b6000001ab-1501060803.338282-617044629', 03:01:10 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:01:10 INFO - '_': '/tools/buildbot/bin/python'} 03:01:10 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:01:10 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 03:01:10 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash>=0.15 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 2)) 03:01:10 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.2 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 3)) 03:01:10 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd>=0.7 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 03:01:10 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo>=0.8 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 5)) 03:01:10 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.22 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 6)) 03:01:10 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 7)) 03:01:10 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile>=0.25 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 8)) 03:01:10 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 9)) 03:01:10 INFO - Downloading/unpacking marionette-driver>=1.4.0 (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 10)) 03:01:10 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:01:10 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:01:10 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:01:10 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:01:11 INFO - Downloading marionette_driver-1.4.0.tar.gz 03:01:11 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/marionette-driver/setup.py) egg_info for package marionette-driver 03:01:11 INFO - Downloading/unpacking simplejson>=2.1.1 (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 11)) 03:01:11 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:01:11 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:01:11 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:01:11 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:01:11 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/simplejson/setup.py) egg_info for package simplejson 03:01:11 INFO - Requirement already satisfied (use --upgrade to upgrade): blessings>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozlog>=3.1->-r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 03:01:11 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozhttpd>=0.7->-r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 03:01:11 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner>=6.9 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from marionette-driver>=1.4.0->-r /builds/slave/test/build/tests/talos/requirements.txt (line 10)) 03:01:11 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice>=0.37 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozrunner>=6.9->marionette-driver>=1.4.0->-r /builds/slave/test/build/tests/talos/requirements.txt (line 10)) 03:01:11 INFO - Installing collected packages: marionette-driver, simplejson 03:01:11 INFO - Running setup.py install for marionette-driver 03:01:12 INFO - Running setup.py install for simplejson 03:01:12 INFO - building 'simplejson._speedups' extension 03:01:12 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -I/usr/include/python2.7 -c simplejson/_speedups.c -o build/temp.linux-x86_64-2.7/simplejson/_speedups.o 03:01:13 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/simplejson/_speedups.o -o build/lib.linux-x86_64-2.7/simplejson/_speedups.so 03:01:13 INFO - Successfully installed marionette-driver simplejson 03:01:13 INFO - Cleaning up... 03:01:13 INFO - Return code: 0 03:01:13 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 03:01:13 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:01:13 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:01:13 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:01:13 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:01:13 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x28981f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2a64a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2c07d10>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2c04eb0>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2c05db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2c06240>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '934fc3100db09dcb9af4d4b6000001ab-1501060803.338282-617044629', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 03:01:13 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema'] in /builds/slave/test/build 03:01:13 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema 03:01:13 INFO - Using env: {'DISPLAY': ':0', 03:01:13 INFO - 'HOME': '/home/cltbld', 03:01:13 INFO - 'LANG': 'en_US.UTF-8', 03:01:13 INFO - 'LANGUAGE': 'en_US:en', 03:01:13 INFO - 'LOGNAME': 'cltbld', 03:01:13 INFO - 'MAIL': '/var/mail/cltbld', 03:01:13 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:01:13 INFO - 'MOZ_NO_REMOTE': '1', 03:01:13 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:01:13 INFO - 'NO_EM_RESTART': '1', 03:01:13 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:01:13 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:01:13 INFO - 'PWD': '/builds/slave/test', 03:01:13 INFO - 'SHELL': '/bin/bash', 03:01:13 INFO - 'SHLVL': '1', 03:01:13 INFO - 'TERM': 'linux', 03:01:13 INFO - 'TMOUT': '86400', 03:01:13 INFO - 'USER': 'cltbld', 03:01:13 INFO - 'XDG_SESSION_COOKIE': '934fc3100db09dcb9af4d4b6000001ab-1501060803.338282-617044629', 03:01:13 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:01:13 INFO - '_': '/tools/buildbot/bin/python'} 03:01:13 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:01:13 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 03:01:13 INFO - Cleaning up... 03:01:13 INFO - Return code: 0 03:01:13 INFO - Running post-action listener: _resource_record_post_action 03:01:13 INFO - Running post-action listener: _start_resource_monitoring 03:01:13 INFO - Starting resource monitoring. 03:01:13 INFO - [mozharness: 2017-07-26 10:01:13.417828Z] Finished create-virtualenv step (success) 03:01:13 INFO - [mozharness: 2017-07-26 10:01:13.418341Z] Running install step. 03:01:13 INFO - Running pre-action listener: _resource_record_pre_action 03:01:13 INFO - Running main action method: install 03:01:13 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 03:01:13 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 03:01:13 INFO - Reading from file tmpfile_stdout 03:01:13 INFO - Detecting whether we're running mozinstall >=1.0... 03:01:13 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 03:01:13 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 03:01:13 INFO - Reading from file tmpfile_stdout 03:01:13 INFO - Output received: 03:01:13 INFO - Usage: mozinstall [options] installer 03:01:13 INFO - Options: 03:01:13 INFO - -h, --help show this help message and exit 03:01:13 INFO - -d DEST, --destination=DEST 03:01:13 INFO - Directory to install application into. [default: 03:01:13 INFO - "/builds/slave/test"] 03:01:13 INFO - --app=APP Application being installed. [default: firefox] 03:01:13 INFO - mkdir: /builds/slave/test/build/application 03:01:13 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/target.tar.bz2', '--destination', '/builds/slave/test/build/application'] 03:01:13 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/target.tar.bz2 --destination /builds/slave/test/build/application 03:01:31 INFO - Reading from file tmpfile_stdout 03:01:31 INFO - Output received: 03:01:31 INFO - /builds/slave/test/build/application/firefox/firefox 03:01:31 INFO - Running post-action listener: _resource_record_post_action 03:01:31 INFO - [mozharness: 2017-07-26 10:01:31.724508Z] Finished install step (success) 03:01:31 INFO - [mozharness: 2017-07-26 10:01:31.724658Z] Running setup-mitmproxy step. 03:01:31 INFO - Running pre-action listener: _resource_record_pre_action 03:01:31 INFO - Running main action method: setup_mitmproxy 03:01:31 INFO - Skipping: mitmproxy is not required 03:01:31 INFO - Running post-action listener: _resource_record_post_action 03:01:31 INFO - [mozharness: 2017-07-26 10:01:31.725459Z] Finished setup-mitmproxy step (success) 03:01:31 INFO - [mozharness: 2017-07-26 10:01:31.725781Z] Running run-tests step. 03:01:31 INFO - Running pre-action listener: _resource_record_pre_action 03:01:31 INFO - Running pre-action listener: _set_gcov_prefix 03:01:31 INFO - Running main action method: run_tests 03:01:31 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 03:01:31 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 03:01:31 INFO - Python 2.7.3 03:01:31 INFO - Return code: 0 03:01:31 INFO - grabbing minidump binary from tooltool 03:01:31 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:01:31 INFO - retry: Calling run_command with args: (['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'],), kwargs: {'output_timeout': 600, 'error_list': [{'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2c04eb0>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2c05db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2c06240>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 03:01:31 INFO - Running command: ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] in /builds/slave/test/build 03:01:31 INFO - Copy/paste: /tools/tooltool.py --url https://api.pub.build.mozilla.org/tooltool/ --authentication-file /builds/relengapi.tok fetch -m /builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest -o -c /builds/tooltool_cache 03:01:31 INFO - Calling ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] with output_timeout 600 03:01:31 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 03:01:31 INFO - Return code: 0 03:01:31 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 03:01:31 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 03:01:31 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 03:01:31 INFO - ENV: RUST_BACKTRACE is now 1 03:01:31 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 03:01:31 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 03:01:31 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/IWL1hFHuQNKITtjZ11Me9g/artifacts/public/build/target.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-057', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] in /builds/slave/test/build 03:01:31 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Firefox --suite dromaeojs-e10s --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/IWL1hFHuQNKITtjZ11Me9g/artifacts/public/build/target.crashreporter-symbols.zip --title talos-linux64-ix-057 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log 03:01:31 INFO - Using env: {'DISPLAY': ':0', 03:01:31 INFO - 'HOME': '/home/cltbld', 03:01:31 INFO - 'LANG': 'en_US.UTF-8', 03:01:31 INFO - 'LANGUAGE': 'en_US:en', 03:01:31 INFO - 'LOGNAME': 'cltbld', 03:01:31 INFO - 'MAIL': '/var/mail/cltbld', 03:01:31 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 03:01:31 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 03:01:31 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:01:31 INFO - 'MOZ_NO_REMOTE': '1', 03:01:31 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 03:01:31 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:01:31 INFO - 'NO_EM_RESTART': '1', 03:01:31 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:01:31 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:01:31 INFO - 'PWD': '/builds/slave/test', 03:01:31 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 03:01:31 INFO - 'RUST_BACKTRACE': '1', 03:01:31 INFO - 'SCRIPTSPATH': '/builds/slave/test/scripts', 03:01:31 INFO - 'SHELL': '/bin/bash', 03:01:31 INFO - 'SHLVL': '1', 03:01:31 INFO - 'STYLO_FORCE_ENABLED': '1', 03:01:31 INFO - 'TERM': 'linux', 03:01:31 INFO - 'TMOUT': '86400', 03:01:31 INFO - 'USER': 'cltbld', 03:01:31 INFO - 'XDG_SESSION_COOKIE': '934fc3100db09dcb9af4d4b6000001ab-1501060803.338282-617044629', 03:01:31 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:01:31 INFO - '_': '/tools/buildbot/bin/python'} 03:01:31 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/IWL1hFHuQNKITtjZ11Me9g/artifacts/public/build/target.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-057', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] with output_timeout 3600 03:01:32 INFO - mozversion application_buildid: 20170726091208 03:01:32 INFO - mozversion application_changeset: e8400551c2e39f24c75a009ebed496c7acd7bf47 03:01:32 INFO - mozversion application_display_name: Nightly 03:01:32 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 03:01:32 INFO - mozversion application_name: Firefox 03:01:32 INFO - mozversion application_remotingname: firefox 03:01:32 INFO - mozversion application_repository: https://hg.mozilla.org/mozilla-central 03:01:32 INFO - mozversion application_vendor: Mozilla 03:01:32 INFO - mozversion application_version: 56.0a1 03:01:32 INFO - mozversion platform_buildid: 20170726091208 03:01:32 INFO - mozversion platform_changeset: e8400551c2e39f24c75a009ebed496c7acd7bf47 03:01:32 INFO - mozversion platform_repository: https://hg.mozilla.org/mozilla-central 03:01:32 INFO - mozversion platform_version: 56.0a1 03:01:32 INFO - using testdate: 1501063292 03:01:32 INFO - actual date: 1501063292 03:01:32 INFO - starting webserver on 'localhost:41183' 03:01:32 INFO - SUITE-START | Running 2 tests 03:01:32 INFO - TEST-START | dromaeo_css 03:01:32 INFO - Initialising browser for dromaeo_css test... 03:01:32 INFO - Application command: /builds/slave/test/build/application/firefox/firefox http://localhost:41183/getInfo.html -profile /tmp/tmpqzZO0K/profile 03:01:32 INFO - TEST-INFO | started process 10399 (/builds/slave/test/build/application/firefox/firefox http://localhost:41183/getInfo.html) 03:01:38 INFO - TEST-INFO | 10399: exit 0 03:01:38 INFO - Browser initialized. 03:01:38 INFO - Running cycle 1/1 for dromaeo_css test... 03:01:38 INFO - TEST-INFO | started process 10627 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpqzZO0K/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpnoisy -tpcycles 1 -tppagecycles 1) 03:01:39 INFO - PID 10627 | 03:01:39 INFO - PID 10627 | (/builds/slave/test/build/application/firefox/firefox:10681): Pango-WARNING **: error opening config file '/home/cltbld/.pangorc': Permission denied 03:01:39 INFO - PID 10627 | 03:01:49 INFO - PID 10627 | RSS: Main: 172523520 03:01:49 INFO - PID 10627 | 03:04:49 INFO - PID 10627 | Cycle 1(1): loaded http://localhost:41183/tests/dromaeo/cssquery-dojo.html (next: http://localhost:41183/tests/dromaeo/cssquery-ext.html) 03:04:50 INFO - PID 10627 | RSS: Main: 172523520 03:04:50 INFO - PID 10627 | 03:07:52 INFO - PID 10627 | Cycle 1(1): loaded http://localhost:41183/tests/dromaeo/cssquery-ext.html (next: http://localhost:41183/tests/dromaeo/cssquery-jquery.html) 03:07:52 INFO - PID 10627 | RSS: Main: 171888640 03:07:52 INFO - PID 10627 | 03:10:54 INFO - PID 10627 | Cycle 1(1): loaded http://localhost:41183/tests/dromaeo/cssquery-jquery.html (next: http://localhost:41183/tests/dromaeo/cssquery-mootools.html) 03:10:55 INFO - PID 10627 | RSS: Main: 174858240 03:10:55 INFO - PID 10627 | 03:13:57 INFO - PID 10627 | Cycle 1(1): loaded http://localhost:41183/tests/dromaeo/cssquery-mootools.html (next: http://localhost:41183/tests/dromaeo/cssquery-prototype.html) 03:13:58 INFO - PID 10627 | RSS: Main: 172752896 03:13:58 INFO - PID 10627 | 03:17:02 INFO - PID 10627 | Cycle 1(1): loaded http://localhost:41183/tests/dromaeo/cssquery-prototype.html (next: http://localhost:41183/tests/dromaeo/cssquery-yui.html) 03:17:02 INFO - PID 10627 | RSS: Main: 174264320 03:17:02 INFO - PID 10627 | 03:20:04 INFO - PID 10627 | Cycle 1(1): loaded http://localhost:41183/tests/dromaeo/cssquery-yui.html (next: http://localhost:41183/tests/dromaeo/cssquery-dojo.html) 03:20:04 INFO - PID 10627 | RSS: Main: 177074176 03:20:04 INFO - PID 10627 | 03:20:04 INFO - PID 10627 | __start_tp_report 03:20:04 INFO - PID 10627 | _x_x_mozilla_page_load 03:20:04 INFO - PID 10627 | _x_x_mozilla_page_load_details 03:20:04 INFO - PID 10627 | |i|pagename|runs| 03:20:04 INFO - PID 10627 | |0;dojo.html;3050.755939524838;3108.6891310868914;3122.484790009648;3130.07662739492;3133.592632957715;6073.149759033728;6082.422169893858;6110.847228819282;6166.4450199482035;6209.254889413277;5993.820185394434;6102.17620621216;6141.477974372173;6165.753369865211;6183.443490085891;5619.381867994528;5644.322681278252;5653.406392328808;5683.175939488771;5778.7977420790285;5708.0581704019;5716.428357164271;5741.684207368593;5748.626339287954;5748.97125514374;5382.515573598355;5567;5616.859578510529;5704.48659620634;5713.285839270091;5586.804461843816;5630.943690563083;5684.63049901755;5703.914441283384;5730.914036289459;5584.050711379075;5602.1036634138745;5605.691686957216;5664.433556644302;5668.546516278729;5982.73077711504;6025.126356678257;6107.938920610826;6108.633481991094;6147.385261473862;6558.344165583451;6606.8017959461295;6631.1379520662485;6660.9000864987065;6687.632180230085;6626.768063117768;6654.70053847578;6729.629870357128;6733.259341472434;6753.358430949052;6062.060380641008;6190.628562286232;6244.906326405107;6274.56078074535;6289.0880822280515;6735.865282694319;6741.865162696817;6750.189977202669;6751.054852320679;6763.222229443579;6410.743570257231;6466.902996455057;6535.3464653534265;6576.967115164393;6577.506686998494;6587.341265873471;6614.8346291343105;6664.633445160466;6705.664716764142;6713.530052896251;6440.935590644127;6576.243731970789;6580.967095164494;6662.6335551545135;6681.699323530453;6549.312322206195;6563.573367731082;6624.900626490607;6628.436582890412;6630;5274.129768588216;5335.093034184198;5349.786008559692;5350;5361.08861493547;4554.749488778083;4581.083783243364;4589.990202155521;4603.58567728906;4618.261078227468;5695.088785794253;5725.456081672234;5728.51307638847;5764.769409223668;5813.7383817728305;6630.9336906630315;6677.998300254903;6715.4291885190305;6716.966415167893;6718.93281067183;5722.7424765885635;5726.511107112181;5795.971020144957;5805.245318108618;5811.9709401453565;5734.254546908875;5774.162746401748;5857.150713146655;5859.53123750099;5863.589548731547;6310.842228944313;6380.3619638035825;6385.808425747328;6391.648459334781;6395.840103997344;6561.868762624817;6592.538522303393;6594.934050659624;6598.802035938929;6605.57063790852;6274.309825919237;6365.077063825812;6365.490760739037;6369;6385.489160867212;6388.9041664374145;6439.67801609927;6470.514711396759;6470.611763294218;6471.191101112361;6335.968320158369;6553.082568440517;6573.1454910861285;6579.078928949855;6673.666316684049;6198.907016394848;6429.035644653152;6433.581817181868;6441.227052753699;6509.283978762427;6229.626222426669;6392.20097487814;6431.903521447089;6494.967525162533;6505.2844187138435;6257.530685198537;6349.142865713255;6381.87236255263;6448.226212854487;6472.838179045561;6433.839154021187;6452.096706461005;6456.580322279036;6478.093066970722;6498.967505162444;6207.844803879939;6264.091706702411;6264.906026409516;6275.96862015687;6281.277653069956 03:20:04 INFO - PID 10627 | |1;ext.html;820.3929092471569;868.452874688946;889.8976617688966;894.5795476126223;1190.4285942747476;31880.99999999997;32472.1881952951;43652.563474365284;44333.33499997495;44493.77753111238;43917.12165756683;44491.555084449144;44493;44643.77678111613;44829;7325.413966882663;7762.883556746639;7964.999999999971;8001.159878212791;8040.477368971027;7874.094479134887;7970.362371010306;7974.401919856005;7981.760547183565;7994.48035877669;7919.168487308836;7989.760307190764;7990.520568765893;7993.160718124572;7997.080335761375;7900.486468379537;7915.089764677049;7944.682212711485;7947.08608510023;7982.481138725964;7713.34436572892;7786.532808031537;7838.490498117661;7856.842863142762;7861.606919653995;38890.80554597237;39204.215915681525;39233.803830980665;39252.60747392518;39301.803490982646;3562.5724913010345;3593.8562457501666;3603.657652523006;3604.8017359045243;3615.0600843780544;31686.36627267442;31856;31894.840525797455;31899.840500797578;31986.520202196985;4546.954530454686;4584.518625544303;4619.0530941156985;4643.303504474356;4698.3187437821325;194179;195781.14765983264;195808;197452.99999999857;198733;50665.73335666638;50698;50714.74642626763;50738.23892641613;50798.746006269736;52553;52595;52669.47330526722;56637.71681141568;57892.71053644705;14482.565523034325;14721.411143554353;14729.484468043567;14762.261886905826;14773.92613036928;11753.88246117545;12033.939830300793;12200.816987745191;12202.877971220352;12421.689457763629;14952.40190392394;14967.176805275596;15006.474773382879;15135.318910649048;15150.31823567942;5897.49871260939;5950.256217972754;6028.608140470856;6060.757569697251;6145.9692701536205;978.5400861595039;1006.6577363696379;1021.274894824668;1025.333533203409;1048.5596049659162;23168.4207894804;23409.882950585477;23465;23477.765222347898;23661.7633823663;1094.4691824465128;1121.7588218533056;1135.3244819332483;1137.5051852444212;1145.1983611471837;11787.29276243411;12566.183198092094;12595.24428534291;12726;12752.93623531895;245323;249749;250240;250462;250827;59527.702361487914;59799.70100149558;59870.40129598735;59917.10124348138;60148;1490.4559835659907;1491.5599898030107;1497.176552895903;1518.574799056266;1531.3491765999406;26568.468630627667;28015.299617509725;28032.29919252035;28121.859390702917;28418;37688.43467347937;37987.620123798406;38100;38275.42586861255;38278;179961;182372;182557;183028;183031;35885.820570896976;38361.46554137915;39002;39152.41271380874;39284.80357598308;45678.77160614176;47612.047759045316;48230.27654585254;48265;48617.5138248613;33462.83268583739;34355.4846677305;34700;35024.64975350214;35436.64563354333;32322.676773231968;33075;33540.32919341648;33937;34534.48198276978;36277.455838162976;38378;38437.423438647886;38577.42133867938;38598.42102368523;30242;31856;32634;32876.835615821765;33080.83459582687;23443.648345275175;24763.876180618983;24829.627555586318;25137.74862251354;25628.231153065437 03:20:04 INFO - PID 10627 | |2;jquery.html;583.3985709228169;584.6229182177495;587.8677297608042;600.8678090820018;606.2936678769235;21939;22229.333120006384;22715.545689086208;22719.886400568015;22748.88625556874;25645.87177064112;25899.999999999953;26014.08950686726;26089.608655870175;26096.47807043863;6554.082428460008;6697.062411262427;6711.798646040626;6713.865722685543;6717.361850624183;5908.497777688902;6208.875822483547;6471.676416179196;6502.122213501188;6508.8047358579315;6429.421352078312;6434.356564343575;6441.162648855666;6448.065030570565;6451.935480645204;6424.38968298011;6435.292117867031;6438.323975982525;6465.288818229991;6489.383508566679;5984.760609575612;5992.9700351498395;5997.970010149965;6030.306514750772;6035.637861728311;27116.186514404402;29244;29358.85320573405;29504.557431638543;29896.701032989607;1846.3999200259968;1873.2506997201092;1886.217219853759;1887.3677318098453;1898.9905050474797;18346.26614935401;18812.905935470237;18976.905115474474;18982.145803438878;19038;2359.528094381131;2389.127968291561;2406.0255596483453;2419.806415486757;2426.8786560671897;140273;143825;143837.28081359525;144076.27961860123;144248.27875860553;14417.42330306776;15089.396424143131;15151.318190681446;15323.233838308262;15490.380384784708;23445.17941872026;23857.52284954291;23876.044958201477;23876.880615596812;23908.402289942544;10211;10232.130268927076;10371.740706482398;10404.739881502872;10469.853679995735;9586;9638.084381983701;9641.614335426504;9815.460149691835;9838.06538378853;7729.704907558989;9154.267658587298;9412.67055653049;9485.4782986935;9502.42985420863;2731.1396909973296;2756.5865120232124;2780.972190278071;2787.4425114977084;2834.5748137779497;961.1781926452783;981.7202097402206;983.7983213441228;989.9010098990043;997.3567049253191;18738;19250.71123933142;19270.518237044187;19686.803131968783;19752.40742777719;981.6858605246252;1010.2776514791959;1029.763154474475;1052.6157952347492;1062;10125.949370253102;10584.100351470057;10822.675319740263;10846.457677116112;11008.889911100947;501304;504446;505850;511707;513210;121786;125732.37133814272;128914;129315;129708.3514582421;1265.943032563537;1269.181378011196;1309.9934500327438;1313.5074347120021;1326.4826717580152;19552.413427597196;20295.28966486166;20584.883023395083;20869;21364.038618262526;55990;59530.70234648799;60433.69783151056;61576.384236157064;62759.37240627535;70225.64887175735;70977;71122.64438677774;71250;71839.28160718326;12304.323262220305;12959.935200323938;13834.93082534581;14502.492412765503;14885.627859303604;22712.659310110692;23051.884740576188;23117.537649247257;23170.884145579163;23262.185823496096;17997.820021800137;18105.456836294932;18980.71528927095;19079.427617171506;19208.519787004876;16210.918945405198;16338.595179816415;17173.484795456156;17205.827941720923;17580.296788128333;18618.906905465385;19360.225590976203;20003.899980500006;20053.495987801267;20077.698834517203;14543.41826326935;14769.261536923326;14816.777748334;14840.332185051482;14880.553583392515;17571.56071098233;18350;18507;18542.81457185411;18678.906605466887 03:20:04 INFO - PID 10627 | |3;mootools.html;1333.959981200564;1396.783498557724;1410.464023671005;1420.1266221273913;1426.7788492783616;13411.59765207044;14004.789928151073;14053.437862485514;14059.437622495088;14070.507532236374;13267.336633168352;13858.861411385884;14445.061071030375;14449.78325325121;14474.348654310556;2606.7393260673925;2631.6841978962552;2665.8533780642056;2673.211402636227;2675.2776750277512;2521.319243804172;2631.460550587125;2667.1065193160316;2671.7194694557083;2675.906343277986;2608.1784237965076;2612.203278000209;2628.1852625686;2657.840529568232;2659.2819938616562;2604.7395260473895;2613.89544418223;2617.9083732069475;2642.392249782551;2643.15419065899;2574.382148284417;2589;2590.779783718386;2595.4938786936555;2596.519643865872;13392.397342119628;13639.659008524766;13710.588682339545;13722.519711810039;13726.862731372657;7176.569405835614;7489.700411983514;7496.362809161228;7504.812379690551;7506.699732010713;4853.490383509751;4985.401751789772;4990.725510096943;5137.614678899097;5162.845114646567;1730.4030109612163;1735.4359833054182;1736.2967997960845;1786.490850107713;1788.5886246163325;22332.106715731352;22476.55046899053;22536.661950070764;22545.887270563544;22580.20969266068;6128.3565225651555;6281.434670879551;6458.321876202931;6486.383793539606;6505.577137486048;14786.556403307703;15510.30203640839;15541.45604903823;15595.61010974712;15631.3747450103;7207.387372073433;7423.851522969619;7428.739994100289;7465.925340746631;7467.402607791364;5602.299712535933;5822.214001109881;6035.818925432244;6052.878942421127;6848.315168483112;4788.952110478851;4834.540718631724;4875.658703890694;5036.118679231193;5068.594512438996;1324.8542660307357;1334.0728193905336;1337.8595247499068;1347.5755137131773;1369.3906211735682;836.8200836820113;839.9370047246481;862.4609618988133;888.2094935507274;909.054583233443;7329.670164842595;7365.963170184222;7407.370373518203;7481.401487881065;7505.737299194502;965.1603105298435;978.6085565773606;1004.7437903334749;1015.94920253987;1035.342557476008;5098.827269727984;5112.9744351278005;5149.588032957355;5172.146595811724;5234.712090834964;18240.361587344378;19240.23039078449;19641.705374419395;19777.604447910962;19804.90097549503;18945.052747362577;18986.71519927202;19464.70802937957;19475.51311217231;19535.706964395544;10110.545025473872;10628.681139565826;10667.573297068031;10731.302465339728;10788.946055269831;7028.929710702828;7925.881111783213;7956.920430795618;8080.717174899086;8084.919150808417;16399.508014759576;16630.50108496747;16698.749518756984;17128.229229684446;17483.56291092733;15774.447894323643;17196.14019299005;17440.651186976444;17548.473545793648;17598.208080636658;10765.46172691378;11107;11669.708257293636;11756.823647645464;11759.588414405796;13088.738225235633;13194.670133246746;13195.868041319463;13199.802002969771;13202.207867527979;10336.735196963033;10707.304025238334;10752;10912.399818009768;10988.285761425483;10028.24788140907;10586.180645739218;10702.464876756287;10721.839172412576;10792.784144316913;9282.767930801514;9717.368371055858;9720.173785228335;9724.805503890024;9724.854127188239;6774.729010839708;6830.351116643911;7048.823779405556;7173.175084865307;7214.314640109181;7213.855722885408;7266.418686504961;7347.412207023533;7349.081364829396;7442.218567050381 03:20:04 INFO - PID 10627 | |4;prototype.html;490.4433468013803;509.4421608338869;521.2259794205604;524.45718681165;530.5622861139561;6219.6268223906545;6247.937520624792;6255.249370075586;6266.279377871546;6288.830353528031;5906.61606995545;6001.849953751147;6031.24609423822;6076.149339092531;6125.08123781433;4843.78202980865;4847.2002119650215;4879.097152110662;4879.39007624047;4899.48555401683;4879.512048795127;4890.070886531547;4905.681130726509;4915.238138088602;4920.778564964585;4742.217534106868;4898.583620392271;4911.410630724318;4926.3842019747535;4960.751962401883;4889.975550122226;4895.730734809584;4930.309756634074;4937.642148409181;4940.777665005047;4359.346098085281;4392.143532011259;4417.3815665806815;4438.556144385568;4441.822327106945;5944.464998150144;5982.970085149546;5984.461398474158;6003.759849606011;6036.577439579231;5625.46558076982;5693.459121383462;5695.231143795576;5700.37295897451;5708.343540492813;6396.360363963613;6423.87152256957;6441.355864413568;6489.67551622417;6497.415232629039;4796.328514008042;4796.880077998043;4832.395950506187;4841.975790121027;4843.505594618774;6839;6852.554583952077;6858.485613578951;6866.279040700754;6881.724731010753;4880.731559764176;4923.261510773413;4935.481774413706;4940.851774446701;4976.800927962913;4977.925331120036;4995;5018.247262910592;5021.548060674557;5029.396472423333;5654.886902261932;5674.333063460167;5701.173329867229;5702.45826646468;5711.543076553949;6513.772017979348;6573.94816829305;6577.967110164419;6628.5360024798765;6633.6019838809825;1646.9341226350812;1665.933362665504;1695.7625932369479;1722.5951901303183;1724.04315604838;1183.1185766603762;1212.7877621416394;1219.878012198773;1227.2145826670937;1244.4959791284364;5698.629589076697;5718.79984200551;5748.913766293509;5755.568332375088;5796.971015144982;6514.348565143448;6578.342165783383;6588.637624930579;6676.9332306676315;6677.732890684319;5743.138529220567;5743.511801496836;5763.3084029915835;5788.363280039192;5793.826185214366;3508.4035713928693;3553.857845686195;3555.7866528008403;3585.2112535242204;3597.9280414391565;6400.743970241138;6465.4827613790785;6465.903011454832;6466.450351720063;6501.2198536175965;6779.525433219627;6783.389494945479;6786.151731033621;6812.897806532906;6819.24988251292;6289.371062893765;6346.270178929482;6346.333634968354;6447.323031081669;6481.578697384655;6497.155369802084;6498;6558.672066396565;6595.8021259362295;6604.471642268511;6425.710843012169;6482.740690372521;6557.967210163919;6581;6588;6331.430171284606;6361.14124593174;6428.614283143026;6442;6453;4883.682560633548;4884.926726099183;4920;4924.679895806761;4965.230389289666;6586.604803711601;6613.107230523818;6636.900446493403;6653.700583473852;6689.732410703712;6449.838754031187;6453.709583068867;6487.870242595027;6514.9348506514325;6514.947791445679;6440;6498.675066246763;6507.6746162692625;6508.219013718195;6513.641749703622;5921.703914804157;6364.459020983269;6424.357564243538;6435.935640643721;6453.870922581428;6511.270082327522;6534.869302613826;6575.901361479678;6576.408123268738;6579.605223686594;6223.253209614694;6338.176037115146;6345.96827015862;6349.460295874717;6350.396712312323 03:20:04 INFO - PID 10627 | |5;yui.html;922.7370199493143;926.745145085102;933.2487347685111;950.1258841865483;966.4877614864122;18359.541011474703;19057.52356191096;19157.042147892604;19254.326098586553;22110.88944555279;21493.355199344005;22139.446513837163;22274.88862555685;22288.219912303073;22470;1027.6660085472233;1055.0504545908705;1055.1506037639697;1056.234230183115;1059.2373491086405;1034.6275340877278;1050.4327663061938;1051.9158467322595;1052.2634156090728;1052.8157572424834;1055.2191378379982;1100.8403781451684;1107.2194103157256;1113.2485572238747;1115.2082021764556;1086.5327908999127;1090.9454527273645;1094.31058433187;1096.0519150934424;1098.4782228441507;795.777182388932;801.863683173856;805.879118132279;806.8587997100484;807.8303556253194;19519.121639526256;19714;20003.6999445007;20023.09896054681;20434.489137771525;20471.18115275387;20597.691034634492;20816.895915520476;21005.789942100688;21175.894120529454;15362.231888405535;15466.61333466661;15523.922380388025;15532;15604;3579.3736096183325;3601.873934412309;3606.062423769839;3615.710743140569;3618.3306088373733;116359.41820290845;120543;122365.38817305857;126361;127895;16201;16850.241739121768;16889.915550422415;16948.661026779395;16956.067416292222;29170.85414572956;30776.076717698506;30794.230144246572;30841.845790771353;30857.537136942963;6684.331566843374;6956;8359.414840961075;8719.912800872036;8885.689000884939;4073.307537718595;4159.667226621863;4161.167766446722;4171.353440216772;4180.581941805795;5070.898582028339;5163.122269214243;5185.48145185486;5191.9480805192225;5196.090684130262;1045.3414348960107;1059.327327147267;1061.098066643347;1072.646026811166;1079.3469950679882;696.689972962027;700.8913618389158;709.5387997801471;715.9248278930742;729.595074733528;11257.774844503065;11598.130140239517;11806.173567850168;12102.455389507493;12177.086718495972;662.1326062857672;673.7473447457204;676.9593824370553;697.1773307497101;706.5336877660719;5451.64564303319;5469.343678758574;5484.341878974548;5634.549236061187;5808.5933984621515;99530;101537;103041;105211;109360;86655.56672216725;90840;95128;95684.52157739167;95906;77907.61046194845;78946.6052669733;81961;84014.5799271012;84971;11076;11317.264377815416;11406.714832129263;11751.059915206934;12219.26684398939;34325.65674343224;36932.44601331036;37424.812875935444;37449.43825842669;39661.2067758649;60609.69695151496;64630;65795.67102164458;66568.33431665815;66850.3314966844;18732;18878;18879.811201888355;19067.904660477165;19144.234230631177;20959.37121886346;21477.785222147577;21523.677144842528;21757;22059.22792702248;18963.715544267125;19069.618607628046;19093.23627054958;19474.90262548735;19565.119569619117;17237.39669111575;17422.390216342366;17596.20817063261;18499.260029598667;20271.59456810885;17818.821811782236;19136.138873750435;19236.903815480833;19683.31108411199;19739.11173997145;13331.466741330238;13997.930010349883;14332.928335358256;14388.640283992983;14859;13866.376013079638;13918.443262269397;14033.578992630237;14196;14760.261986900827 03:20:04 INFO - PID 10627 | __end_tp_report 03:20:04 INFO - PID 10627 | __start_cc_report 03:20:04 INFO - PID 10627 | _x_x_mozilla_cycle_collect,373 03:20:04 INFO - PID 10627 | __end_cc_report 03:20:04 INFO - PID 10627 | __startTimestamp1501064404816__endTimestamp 03:20:04 INFO - PID 10627 | 03:20:04 INFO - PID 10627 | ------- Summary: start ------- 03:20:04 INFO - PID 10627 | Number of tests: 6 03:20:04 INFO - PID 10627 | 03:20:04 INFO - PID 10627 | [#0] dojo.html Cycles:165 Average:6077.29 Median:6281.28 stddev:713.94 (11.4%) stddev-sans-first:675.50 03:20:04 INFO - PID 10627 | Values: 3050.8 3108.7 3122.5 3130.1 3133.6 6073.1 6082.4 6110.8 6166.4 6209.3 5993.8 6102.2 6141.5 6165.8 6183.4 5619.4 5644.3 5653.4 5683.2 5778.8 5708.1 5716.4 5741.7 5748.6 5749.0 5382.5 5567.0 5616.9 5704.5 5713.3 5586.8 5630.9 5684.6 5703.9 5730.9 5584.1 5602.1 5605.7 5664.4 5668.5 5982.7 6025.1 6107.9 6108.6 6147.4 6558.3 6606.8 6631.1 6660.9 6687.6 6626.8 6654.7 6729.6 6733.3 6753.4 6062.1 6190.6 6244.9 6274.6 6289.1 6735.9 6741.9 6750.2 6751.1 6763.2 6410.7 6466.9 6535.3 6577.0 6577.5 6587.3 6614.8 6664.6 6705.7 6713.5 6440.9 6576.2 6581.0 6662.6 6681.7 6549.3 6563.6 6624.9 6628.4 6630.0 5274.1 5335.1 5349.8 5350.0 5361.1 4554.7 4581.1 4590.0 4603.6 4618.3 5695.1 5725.5 5728.5 5764.8 5813.7 6630.9 6678.0 6715.4 6717.0 6718.9 5722.7 5726.5 5796.0 5805.2 5812.0 5734.3 5774.2 5857.2 5859.5 5863.6 6310.8 6380.4 6385.8 6391.6 6395.8 6561.9 6592.5 6594.9 6598.8 6605.6 6274.3 6365.1 6365.5 6369.0 6385.5 6388.9 6439.7 6470.5 6470.6 6471.2 6336.0 6553.1 6573.1 6579.1 6673.7 6198.9 6429.0 6433.6 6441.2 6509.3 6229.6 6392.2 6431.9 6495.0 6505.3 6257.5 6349.1 6381.9 6448.2 6472.8 6433.8 6452.1 6456.6 6478.1 6499.0 6207.8 6264.1 6264.9 6276.0 6281.3 03:20:04 INFO - PID 10627 | 03:20:04 INFO - PID 10627 | [#1] ext.html Cycles:180 Average:38857.58 Median:3604.23 stddev:54895.08 (1523.1%) stddev-sans-first:54974.77 03:20:04 INFO - PID 10627 | Values: 820.4 868.5 889.9 894.6 1190.4 31881.0 32472.2 43652.6 44333.3 44493.8 43917.1 44491.6 44493.0 44643.8 44829.0 7325.4 7762.9 7965.0 8001.2 8040.5 7874.1 7970.4 7974.4 7981.8 7994.5 7919.2 7989.8 7990.5 7993.2 7997.1 7900.5 7915.1 7944.7 7947.1 7982.5 7713.3 7786.5 7838.5 7856.8 7861.6 38890.8 39204.2 39233.8 39252.6 39301.8 3562.6 3593.9 3603.7 3604.8 3615.1 31686.4 31856.0 31894.8 31899.8 31986.5 4547.0 4584.5 4619.1 4643.3 4698.3 194179.0 195781.1 195808.0 197453.0 198733.0 50665.7 50698.0 50714.7 50738.2 50798.7 52553.0 52595.0 52669.5 56637.7 57892.7 14482.6 14721.4 14729.5 14762.3 14773.9 11753.9 12033.9 12200.8 12202.9 12421.7 14952.4 14967.2 15006.5 15135.3 15150.3 5897.5 5950.3 6028.6 6060.8 6146.0 978.5 1006.7 1021.3 1025.3 1048.6 23168.4 23409.9 23465.0 23477.8 23661.8 1094.5 1121.8 1135.3 1137.5 1145.2 11787.3 12566.2 12595.2 12726.0 12752.9 245323.0 249749.0 250240.0 250462.0 250827.0 59527.7 59799.7 59870.4 59917.1 60148.0 1490.5 1491.6 1497.2 1518.6 1531.3 26568.5 28015.3 28032.3 28121.9 28418.0 37688.4 37987.6 38100.0 38275.4 38278.0 179961.0 182372.0 182557.0 183028.0 183031.0 35885.8 38361.5 39002.0 39152.4 39284.8 45678.8 47612.0 48230.3 48265.0 48617.5 33462.8 34355.5 34700.0 35024.6 35436.6 32322.7 33075.0 33540.3 33937.0 34534.5 36277.5 38378.0 38437.4 38577.4 38598.4 30242.0 31856.0 32634.0 32876.8 33080.8 23443.6 24763.9 24829.6 25137.7 25628.2 03:20:04 INFO - PID 10627 | 03:20:04 INFO - PID 10627 | [#2] jquery.html Cycles:180 Average:35875.38 Median:23084.71 stddev:85756.17 (371.5%) stddev-sans-first:85955.80 03:20:04 INFO - PID 10627 | Values: 583.4 584.6 587.9 600.9 606.3 21939.0 22229.3 22715.5 22719.9 22748.9 25645.9 25900.0 26014.1 26089.6 26096.5 6554.1 6697.1 6711.8 6713.9 6717.4 5908.5 6208.9 6471.7 6502.1 6508.8 6429.4 6434.4 6441.2 6448.1 6451.9 6424.4 6435.3 6438.3 6465.3 6489.4 5984.8 5993.0 5998.0 6030.3 6035.6 27116.2 29244.0 29358.9 29504.6 29896.7 1846.4 1873.3 1886.2 1887.4 1899.0 18346.3 18812.9 18976.9 18982.1 19038.0 2359.5 2389.1 2406.0 2419.8 2426.9 140273.0 143825.0 143837.3 144076.3 144248.3 14417.4 15089.4 15151.3 15323.2 15490.4 23445.2 23857.5 23876.0 23876.9 23908.4 10211.0 10232.1 10371.7 10404.7 10469.9 9586.0 9638.1 9641.6 9815.5 9838.1 7729.7 9154.3 9412.7 9485.5 9502.4 2731.1 2756.6 2781.0 2787.4 2834.6 961.2 981.7 983.8 989.9 997.4 18738.0 19250.7 19270.5 19686.8 19752.4 981.7 1010.3 1029.8 1052.6 1062.0 10125.9 10584.1 10822.7 10846.5 11008.9 501304.0 504446.0 505850.0 511707.0 513210.0 121786.0 125732.4 128914.0 129315.0 129708.4 1265.9 1269.2 1310.0 1313.5 1326.5 19552.4 20295.3 20584.9 20869.0 21364.0 55990.0 59530.7 60433.7 61576.4 62759.4 70225.6 70977.0 71122.6 71250.0 71839.3 12304.3 12959.9 13834.9 14502.5 14885.6 22712.7 23051.9 23117.5 23170.9 23262.2 17997.8 18105.5 18980.7 19079.4 19208.5 16210.9 16338.6 17173.5 17205.8 17580.3 18618.9 19360.2 20003.9 20053.5 20077.7 14543.4 14769.3 14816.8 14840.3 14880.6 17571.6 18350.0 18507.0 18542.8 18678.9 03:20:04 INFO - PID 10627 | 03:20:04 INFO - PID 10627 | [#3] mootools.html Cycles:180 Average:8603.27 Median:2589.89 stddev:5895.16 (227.6%) stddev-sans-first:5886.39 03:20:04 INFO - PID 10627 | Values: 1334.0 1396.8 1410.5 1420.1 1426.8 13411.6 14004.8 14053.4 14059.4 14070.5 13267.3 13858.9 14445.1 14449.8 14474.3 2606.7 2631.7 2665.9 2673.2 2675.3 2521.3 2631.5 2667.1 2671.7 2675.9 2608.2 2612.2 2628.2 2657.8 2659.3 2604.7 2613.9 2617.9 2642.4 2643.2 2574.4 2589.0 2590.8 2595.5 2596.5 13392.4 13639.7 13710.6 13722.5 13726.9 7176.6 7489.7 7496.4 7504.8 7506.7 4853.5 4985.4 4990.7 5137.6 5162.8 1730.4 1735.4 1736.3 1786.5 1788.6 22332.1 22476.6 22536.7 22545.9 22580.2 6128.4 6281.4 6458.3 6486.4 6505.6 14786.6 15510.3 15541.5 15595.6 15631.4 7207.4 7423.9 7428.7 7465.9 7467.4 5602.3 5822.2 6035.8 6052.9 6848.3 4789.0 4834.5 4875.7 5036.1 5068.6 1324.9 1334.1 1337.9 1347.6 1369.4 836.8 839.9 862.5 888.2 909.1 7329.7 7366.0 7407.4 7481.4 7505.7 965.2 978.6 1004.7 1015.9 1035.3 5098.8 5113.0 5149.6 5172.1 5234.7 18240.4 19240.2 19641.7 19777.6 19804.9 18945.1 18986.7 19464.7 19475.5 19535.7 10110.5 10628.7 10667.6 10731.3 10788.9 7028.9 7925.9 7956.9 8080.7 8084.9 16399.5 16630.5 16698.7 17128.2 17483.6 15774.4 17196.1 17440.7 17548.5 17598.2 10765.5 11107.0 11669.7 11756.8 11759.6 13088.7 13194.7 13195.9 13199.8 13202.2 10336.7 10707.3 10752.0 10912.4 10988.3 10028.2 10586.2 10702.5 10721.8 10792.8 9282.8 9717.4 9720.2 9724.8 9724.9 6774.7 6830.4 7048.8 7173.2 7214.3 7213.9 7266.4 7347.4 7349.1 7442.2 03:20:04 INFO - PID 10627 | 03:20:04 INFO - PID 10627 | [#4] prototype.html Cycles:180 Average:5451.14 Median:6002.80 stddev:1531.73 (25.5%) stddev-sans-first:1490.09 03:20:04 INFO - PID 10627 | Values: 490.4 509.4 521.2 524.5 530.6 6219.6 6247.9 6255.2 6266.3 6288.8 5906.6 6001.8 6031.2 6076.1 6125.1 4843.8 4847.2 4879.1 4879.4 4899.5 4879.5 4890.1 4905.7 4915.2 4920.8 4742.2 4898.6 4911.4 4926.4 4960.8 4890.0 4895.7 4930.3 4937.6 4940.8 4359.3 4392.1 4417.4 4438.6 4441.8 5944.5 5983.0 5984.5 6003.8 6036.6 5625.5 5693.5 5695.2 5700.4 5708.3 6396.4 6423.9 6441.4 6489.7 6497.4 4796.3 4796.9 4832.4 4842.0 4843.5 6839.0 6852.6 6858.5 6866.3 6881.7 4880.7 4923.3 4935.5 4940.9 4976.8 4977.9 4995.0 5018.2 5021.5 5029.4 5654.9 5674.3 5701.2 5702.5 5711.5 6513.8 6573.9 6578.0 6628.5 6633.6 1646.9 1665.9 1695.8 1722.6 1724.0 1183.1 1212.8 1219.9 1227.2 1244.5 5698.6 5718.8 5748.9 5755.6 5797.0 6514.3 6578.3 6588.6 6676.9 6677.7 5743.1 5743.5 5763.3 5788.4 5793.8 3508.4 3553.9 3555.8 3585.2 3597.9 6400.7 6465.5 6465.9 6466.5 6501.2 6779.5 6783.4 6786.2 6812.9 6819.2 6289.4 6346.3 6346.3 6447.3 6481.6 6497.2 6498.0 6558.7 6595.8 6604.5 6425.7 6482.7 6558.0 6581.0 6588.0 6331.4 6361.1 6428.6 6442.0 6453.0 4883.7 4884.9 4920.0 4924.7 4965.2 6586.6 6613.1 6636.9 6653.7 6689.7 6449.8 6453.7 6487.9 6514.9 6514.9 6440.0 6498.7 6507.7 6508.2 6513.6 5921.7 6364.5 6424.4 6435.9 6453.9 6511.3 6534.9 6575.9 6576.4 6579.6 6223.3 6338.2 6346.0 6349.5 6350.4 03:20:04 INFO - PID 10627 | 03:20:04 INFO - PID 10627 | [#5] yui.html Cycles:180 Average:23104.32 Median:20147.35 stddev:30546.85 (151.6%) stddev-sans-first:30587.14 03:20:04 INFO - PID 10627 | Values: 922.7 926.7 933.2 950.1 966.5 18359.5 19057.5 19157.0 19254.3 22110.9 21493.4 22139.4 22274.9 22288.2 22470.0 1027.7 1055.1 1055.2 1056.2 1059.2 1034.6 1050.4 1051.9 1052.3 1052.8 1055.2 1100.8 1107.2 1113.2 1115.2 1086.5 1090.9 1094.3 1096.1 1098.5 795.8 801.9 805.9 806.9 807.8 19519.1 19714.0 20003.7 20023.1 20434.5 20471.2 20597.7 20816.9 21005.8 21175.9 15362.2 15466.6 15523.9 15532.0 15604.0 3579.4 3601.9 3606.1 3615.7 3618.3 116359.4 120543.0 122365.4 126361.0 127895.0 16201.0 16850.2 16889.9 16948.7 16956.1 29170.9 30776.1 30794.2 30841.8 30857.5 6684.3 6956.0 8359.4 8719.9 8885.7 4073.3 4159.7 4161.2 4171.4 4180.6 5070.9 5163.1 5185.5 5191.9 5196.1 1045.3 1059.3 1061.1 1072.6 1079.3 696.7 700.9 709.5 715.9 729.6 11257.8 11598.1 11806.2 12102.5 12177.1 662.1 673.7 677.0 697.2 706.5 5451.6 5469.3 5484.3 5634.5 5808.6 99530.0 101537.0 103041.0 105211.0 109360.0 86655.6 90840.0 95128.0 95684.5 95906.0 77907.6 78946.6 81961.0 84014.6 84971.0 11076.0 11317.3 11406.7 11751.1 12219.3 34325.7 36932.4 37424.8 37449.4 39661.2 60609.7 64630.0 65795.7 66568.3 66850.3 18732.0 18878.0 18879.8 19067.9 19144.2 20959.4 21477.8 21523.7 21757.0 22059.2 18963.7 19069.6 19093.2 19474.9 19565.1 17237.4 17422.4 17596.2 18499.3 20271.6 17818.8 19136.1 19236.9 19683.3 19739.1 13331.5 13997.9 14332.9 14388.6 14859.0 13866.4 13918.4 14033.6 14196.0 14760.3 03:20:04 INFO - PID 10627 | -------- Summary: end -------- 03:20:04 INFO - PID 10627 | 03:20:05 INFO - TEST-INFO | 10627: exit 0 03:20:05 INFO - TEST-OK | dromaeo_css | took 1113486ms 03:20:05 INFO - TEST-START | kraken 03:20:05 INFO - Initialising browser for kraken test... 03:20:05 INFO - Application command: /builds/slave/test/build/application/firefox/firefox http://localhost:41183/getInfo.html -profile /tmp/tmpMZtHi8/profile 03:20:05 INFO - TEST-INFO | started process 11001 (/builds/slave/test/build/application/firefox/firefox http://localhost:41183/getInfo.html) 03:20:11 INFO - TEST-INFO | 11001: exit 0 03:20:11 INFO - Browser initialized. 03:20:11 INFO - Running cycle 1/1 for kraken test... 03:20:11 INFO - TEST-INFO | started process 11231 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpMZtHi8/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpnoisy -tpcycles 1 -tppagecycles 1) 03:20:12 INFO - PID 11231 | 03:20:12 INFO - PID 11231 | (/builds/slave/test/build/application/firefox/firefox:11286): Pango-WARNING **: error opening config file '/home/cltbld/.pangorc': Permission denied 03:20:12 INFO - PID 11231 | 03:20:22 INFO - PID 11231 | RSS: Main: 170405888 03:20:22 INFO - PID 11231 | 03:20:25 INFO - PID 11231 | Cycle 1(1): loaded http://localhost:41183/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:41183/tests/kraken/driver.html?testName=audio-beat-detection) 03:20:26 INFO - PID 11231 | RSS: Main: 176631808 03:20:26 INFO - PID 11231 | 03:20:29 INFO - PID 11231 | Cycle 1(1): loaded http://localhost:41183/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:41183/tests/kraken/driver.html?testName=audio-dft) 03:20:29 INFO - PID 11231 | RSS: Main: 177782784 03:20:29 INFO - PID 11231 | 03:20:32 INFO - PID 11231 | Cycle 1(1): loaded http://localhost:41183/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:41183/tests/kraken/driver.html?testName=audio-fft) 03:20:33 INFO - PID 11231 | RSS: Main: 172298240 03:20:33 INFO - PID 11231 | 03:20:35 INFO - PID 11231 | Cycle 1(1): loaded http://localhost:41183/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:41183/tests/kraken/driver.html?testName=audio-oscillator) 03:20:36 INFO - PID 11231 | RSS: Main: 172810240 03:20:36 INFO - PID 11231 | 03:20:38 INFO - PID 11231 | Cycle 1(1): loaded http://localhost:41183/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:41183/tests/kraken/driver.html?testName=imaging-gaussian-blur) 03:20:39 INFO - PID 11231 | RSS: Main: 172867584 03:20:39 INFO - PID 11231 | 03:20:42 INFO - PID 11231 | Cycle 1(1): loaded http://localhost:41183/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:41183/tests/kraken/driver.html?testName=imaging-darkroom) 03:20:42 INFO - PID 11231 | RSS: Main: 175902720 03:20:42 INFO - PID 11231 | 03:20:46 INFO - PID 11231 | Cycle 1(1): loaded http://localhost:41183/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:41183/tests/kraken/driver.html?testName=imaging-desaturate) 03:20:46 INFO - PID 11231 | RSS: Main: 175869952 03:20:46 INFO - PID 11231 | 03:20:49 INFO - PID 11231 | Cycle 1(1): loaded http://localhost:41183/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:41183/tests/kraken/driver.html?testName=json-parse-financial) 03:20:50 INFO - PID 11231 | RSS: Main: 176861184 03:20:50 INFO - PID 11231 | 03:20:52 INFO - PID 11231 | Cycle 1(1): loaded http://localhost:41183/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:41183/tests/kraken/driver.html?testName=json-stringify-tinderbox) 03:20:52 INFO - PID 11231 | RSS: Main: 176644096 03:20:52 INFO - PID 11231 | 03:20:54 INFO - PID 11231 | Cycle 1(1): loaded http://localhost:41183/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:41183/tests/kraken/driver.html?testName=stanford-crypto-aes) 03:20:55 INFO - PID 11231 | RSS: Main: 173998080 03:20:55 INFO - PID 11231 | 03:20:57 INFO - PID 11231 | Cycle 1(1): loaded http://localhost:41183/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:41183/tests/kraken/driver.html?testName=stanford-crypto-ccm) 03:20:57 INFO - PID 11231 | RSS: Main: 173633536 03:20:57 INFO - PID 11231 | 03:21:00 INFO - PID 11231 | Cycle 1(1): loaded http://localhost:41183/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:41183/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 03:21:01 INFO - PID 11231 | RSS: Main: 174362624 03:21:01 INFO - PID 11231 | 03:21:04 INFO - PID 11231 | Cycle 1(1): loaded http://localhost:41183/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:41183/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 03:21:05 INFO - PID 11231 | RSS: Main: 174292992 03:21:05 INFO - PID 11231 | 03:21:06 INFO - PID 11231 | Cycle 1(1): loaded http://localhost:41183/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:41183/tests/kraken/driver.html?testName=ai-astar) 03:21:07 INFO - PID 11231 | RSS: Main: 176037888 03:21:07 INFO - PID 11231 | 03:21:07 INFO - PID 11231 | __start_tp_report 03:21:07 INFO - PID 11231 | _x_x_mozilla_page_load 03:21:07 INFO - PID 11231 | _x_x_mozilla_page_load_details 03:21:07 INFO - PID 11231 | |i|pagename|runs| 03:21:07 INFO - PID 11231 | |0;ai-astar;100;110;103;109;108;110;114;102;111;108 03:21:07 INFO - PID 11231 | |1;audio-beat-detection;154;122;146;176;119;149;152;117;173;124 03:21:07 INFO - PID 11231 | |2;audio-dft;162;162;165;165;166;162;162;173;169;167 03:21:07 INFO - PID 11231 | |3;audio-fft;80;77;76;173;78;75;83;74;179;74 03:21:07 INFO - PID 11231 | |4;audio-oscillator;78;78;130;80;81;78;132;79;80;127 03:21:07 INFO - PID 11231 | |5;imaging-gaussian-blur;113;113;114;114;114;114;118;117;117;117 03:21:07 INFO - PID 11231 | |6;imaging-darkroom;151;151;151;151;151;150;152;153;152;151 03:21:07 INFO - PID 11231 | |7;imaging-desaturate;94;94;94;94;94;95;95;96;94;95 03:21:07 INFO - PID 11231 | |8;json-parse-financial;53;59;53;54;53;53;54;53;55;53 03:21:07 INFO - PID 11231 | |9;json-stringify-tinderbox;55;56;55;54;55;55;55;54;56;55 03:21:07 INFO - PID 11231 | |10;stanford-crypto-aes;79;88;84;79;79;77;79;94;78;77 03:21:07 INFO - PID 11231 | |11;stanford-crypto-ccm;144;127;129;128;127;121;122;126;135;174 03:21:07 INFO - PID 11231 | |12;stanford-crypto-pbkdf2;185;177;173;176;174;185;176;173;175;175 03:21:07 INFO - PID 11231 | |13;stanford-crypto-sha256-iterative;69;70;68;67;67;68;68;69;68;67 03:21:07 INFO - PID 11231 | __end_tp_report 03:21:07 INFO - PID 11231 | __start_cc_report 03:21:07 INFO - PID 11231 | _x_x_mozilla_cycle_collect,998 03:21:07 INFO - PID 11231 | __end_cc_report 03:21:07 INFO - PID 11231 | __startTimestamp1501064467124__endTimestamp 03:21:07 INFO - PID 11231 | 03:21:07 INFO - PID 11231 | ------- Summary: start ------- 03:21:07 INFO - PID 11231 | Number of tests: 14 03:21:07 INFO - PID 11231 | 03:21:07 INFO - PID 11231 | [#0] ai-astar Cycles:10 Average:107.50 Median:109.50 stddev:4.43 (4.0%) stddev-sans-first:3.77 03:21:07 INFO - PID 11231 | Values: 100.0 110.0 103.0 109.0 108.0 110.0 114.0 102.0 111.0 108.0 03:21:07 INFO - PID 11231 | 03:21:07 INFO - PID 11231 | [#1] audio-beat-detection Cycles:10 Average:143.20 Median:150.50 stddev:21.83 (14.5%) stddev-sans-first:22.80 03:21:07 INFO - PID 11231 | Values: 154.0 122.0 146.0 176.0 119.0 149.0 152.0 117.0 173.0 124.0 03:21:07 INFO - PID 11231 | 03:21:07 INFO - PID 11231 | [#2] audio-dft Cycles:10 Average:165.30 Median:165.50 stddev:3.65 (2.2%) stddev-sans-first:3.67 03:21:07 INFO - PID 11231 | Values: 162.0 162.0 165.0 165.0 166.0 162.0 162.0 173.0 169.0 167.0 03:21:07 INFO - PID 11231 | 03:21:07 INFO - PID 11231 | [#3] audio-fft Cycles:10 Average:96.90 Median:76.50 stddev:41.80 (54.6%) stddev-sans-first:43.89 03:21:07 INFO - PID 11231 | Values: 80.0 77.0 76.0 173.0 78.0 75.0 83.0 74.0 179.0 74.0 03:21:07 INFO - PID 11231 | 03:21:07 INFO - PID 11231 | [#4] audio-oscillator Cycles:10 Average:94.30 Median:78.50 stddev:24.45 (31.2%) stddev-sans-first:25.22 03:21:07 INFO - PID 11231 | Values: 78.0 78.0 130.0 80.0 81.0 78.0 132.0 79.0 80.0 127.0 03:21:07 INFO - PID 11231 | 03:21:07 INFO - PID 11231 | [#5] imaging-gaussian-blur Cycles:10 Average:115.10 Median:115.50 stddev:1.91 (1.7%) stddev-sans-first:1.87 03:21:07 INFO - PID 11231 | Values: 113.0 113.0 114.0 114.0 114.0 114.0 118.0 117.0 117.0 117.0 03:21:07 INFO - PID 11231 | 03:21:07 INFO - PID 11231 | [#6] imaging-darkroom Cycles:10 Average:151.30 Median:151.00 stddev:0.82 (0.5%) stddev-sans-first:0.87 03:21:07 INFO - PID 11231 | Values: 151.0 151.0 151.0 151.0 151.0 150.0 152.0 153.0 152.0 151.0 03:21:07 INFO - PID 11231 | 03:21:07 INFO - PID 11231 | [#7] imaging-desaturate Cycles:10 Average:94.50 Median:94.50 stddev:0.71 (0.7%) stddev-sans-first:0.73 03:21:07 INFO - PID 11231 | Values: 94.0 94.0 94.0 94.0 94.0 95.0 95.0 96.0 94.0 95.0 03:21:07 INFO - PID 11231 | 03:21:07 INFO - PID 11231 | [#8] json-parse-financial Cycles:10 Average:54.00 Median:53.50 stddev:1.89 (3.5%) stddev-sans-first:1.96 03:21:07 INFO - PID 11231 | Values: 53.0 59.0 53.0 54.0 53.0 53.0 54.0 53.0 55.0 53.0 03:21:07 INFO - PID 11231 | 03:21:07 INFO - PID 11231 | [#9] json-stringify-tinderbox Cycles:10 Average:55.00 Median:55.00 stddev:0.67 (1.2%) stddev-sans-first:0.71 03:21:07 INFO - PID 11231 | Values: 55.0 56.0 55.0 54.0 55.0 55.0 55.0 54.0 56.0 55.0 03:21:07 INFO - PID 11231 | 03:21:07 INFO - PID 11231 | [#10] stanford-crypto-aes Cycles:10 Average:81.40 Median:79.00 stddev:5.60 (7.1%) stddev-sans-first:5.87 03:21:07 INFO - PID 11231 | Values: 79.0 88.0 84.0 79.0 79.0 77.0 79.0 94.0 78.0 77.0 03:21:07 INFO - PID 11231 | 03:21:07 INFO - PID 11231 | [#11] stanford-crypto-ccm Cycles:10 Average:133.30 Median:128.50 stddev:15.75 (12.3%) stddev-sans-first:16.22 03:21:07 INFO - PID 11231 | Values: 144.0 127.0 129.0 128.0 127.0 121.0 122.0 126.0 135.0 174.0 03:21:07 INFO - PID 11231 | 03:21:07 INFO - PID 11231 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:176.90 Median:176.00 stddev:4.46 (2.5%) stddev-sans-first:3.64 03:21:07 INFO - PID 11231 | Values: 185.0 177.0 173.0 176.0 174.0 185.0 176.0 173.0 175.0 175.0 03:21:07 INFO - PID 11231 | 03:21:07 INFO - PID 11231 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:68.10 Median:68.00 stddev:0.99 (1.5%) stddev-sans-first:1.00 03:21:07 INFO - PID 11231 | Values: 69.0 70.0 68.0 67.0 67.0 68.0 68.0 69.0 68.0 67.0 03:21:07 INFO - PID 11231 | -------- Summary: end -------- 03:21:07 INFO - PID 11231 | 03:21:07 INFO - PID 11231 | *** UTM:SVC TimerManager:registerTimer called after profile-before-change notification. Ignoring timer registration for id: telemetry_modules_ping 03:21:07 INFO - TEST-INFO | 11231: exit 0 03:21:07 INFO - TEST-OK | kraken | took 62242ms 03:21:07 INFO - SUITE-END | took 1175s 03:21:08 INFO - Completed test suite (00:19:36) 03:21:08 INFO - javascript benchmark 03:21:08 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": ["e10s"], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 8476.334652583246, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3050.755939524838, 3108.6891310868914, 3122.484790009648, 3130.07662739492, 3133.592632957715, 6073.149759033728, 6082.422169893858, 6110.847228819282, 6166.4450199482035, 6209.254889413277, 5993.820185394434, 6102.17620621216, 6141.477974372173, 6165.753369865211, 6183.443490085891, 5619.381867994528, 5644.322681278252, 5653.406392328808, 5683.175939488771, 5778.7977420790285, 5708.0581704019, 5716.428357164271, 5741.684207368593, 5748.626339287954, 5748.97125514374, 5382.515573598355, 5567.0, 5616.859578510529, 5704.48659620634, 5713.285839270091, 5586.804461843816, 5630.943690563083, 5684.63049901755, 5703.914441283384, 5730.914036289459, 5584.050711379075, 5602.1036634138745, 5605.691686957216, 5664.433556644302, 5668.546516278729, 5982.73077711504, 6025.126356678257, 6107.938920610826, 6108.633481991094, 6147.385261473862, 6558.344165583451, 6606.8017959461295, 6631.1379520662485, 6660.9000864987065, 6687.632180230085, 6626.768063117768, 6654.70053847578, 6729.629870357128, 6733.259341472434, 6753.358430949052, 6062.060380641008, 6190.628562286232, 6244.906326405107, 6274.56078074535, 6289.0880822280515, 6735.865282694319, 6741.865162696817, 6750.189977202669, 6751.054852320679, 6763.222229443579, 6410.743570257231, 6466.902996455057, 6535.3464653534265, 6576.967115164393, 6577.506686998494, 6587.341265873471, 6614.8346291343105, 6664.633445160466, 6705.664716764142, 6713.530052896251, 6440.935590644127, 6576.243731970789, 6580.967095164494, 6662.6335551545135, 6681.699323530453, 6549.312322206195, 6563.573367731082, 6624.900626490607, 6628.436582890412, 6630.0, 5274.129768588216, 5335.093034184198, 5349.786008559692, 5350.0, 5361.08861493547, 4554.749488778083, 4581.083783243364, 4589.990202155521, 4603.58567728906, 4618.261078227468, 5695.088785794253, 5725.456081672234, 5728.51307638847, 5764.769409223668, 5813.7383817728305, 6630.9336906630315, 6677.998300254903, 6715.4291885190305, 6716.966415167893, 6718.93281067183, 5722.7424765885635, 5726.511107112181, 5795.971020144957, 5805.245318108618, 5811.9709401453565, 5734.254546908875, 5774.162746401748, 5857.150713146655, 5859.53123750099, 5863.589548731547, 6310.842228944313, 6380.3619638035825, 6385.808425747328, 6391.648459334781, 6395.840103997344, 6561.868762624817, 6592.538522303393, 6594.934050659624, 6598.802035938929, 6605.57063790852, 6274.309825919237, 6365.077063825812, 6365.490760739037, 6369.0, 6385.489160867212, 6388.9041664374145, 6439.67801609927, 6470.514711396759, 6470.611763294218, 6471.191101112361, 6335.968320158369, 6553.082568440517, 6573.1454910861285, 6579.078928949855, 6673.666316684049, 6198.907016394848, 6429.035644653152, 6433.581817181868, 6441.227052753699, 6509.283978762427, 6229.626222426669, 6392.20097487814, 6431.903521447089, 6494.967525162533, 6505.2844187138435, 6257.530685198537, 6349.142865713255, 6381.87236255263, 6448.226212854487, 6472.838179045561, 6433.839154021187, 6452.096706461005, 6456.580322279036, 6478.093066970722, 6498.967505162444, 6207.844803879939, 6264.091706702411, 6264.906026409516, 6275.96862015687, 6281.277653069956], "value": 6023.770337718899, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [820.3929092471569, 868.452874688946, 889.8976617688966, 894.5795476126223, 1190.4285942747476, 31880.99999999997, 32472.1881952951, 43652.563474365284, 44333.33499997495, 44493.77753111238, 43917.12165756683, 44491.555084449144, 44493.0, 44643.77678111613, 44829.0, 7325.413966882663, 7762.883556746639, 7964.999999999971, 8001.159878212791, 8040.477368971027, 7874.094479134887, 7970.362371010306, 7974.401919856005, 7981.760547183565, 7994.48035877669, 7919.168487308836, 7989.760307190764, 7990.520568765893, 7993.160718124572, 7997.080335761375, 7900.486468379537, 7915.089764677049, 7944.682212711485, 7947.08608510023, 7982.481138725964, 7713.34436572892, 7786.532808031537, 7838.490498117661, 7856.842863142762, 7861.606919653995, 38890.80554597237, 39204.215915681525, 39233.803830980665, 39252.60747392518, 39301.803490982646, 3562.5724913010345, 3593.8562457501666, 3603.657652523006, 3604.8017359045243, 3615.0600843780544, 31686.36627267442, 31856.0, 31894.840525797455, 31899.840500797578, 31986.520202196985, 4546.954530454686, 4584.518625544303, 4619.0530941156985, 4643.303504474356, 4698.3187437821325, 194179.0, 195781.14765983264, 195808.0, 197452.99999999857, 198733.0, 50665.73335666638, 50698.0, 50714.74642626763, 50738.23892641613, 50798.746006269736, 52553.0, 52595.0, 52669.47330526722, 56637.71681141568, 57892.71053644705, 14482.565523034325, 14721.411143554353, 14729.484468043567, 14762.261886905826, 14773.92613036928, 11753.88246117545, 12033.939830300793, 12200.816987745191, 12202.877971220352, 12421.689457763629, 14952.40190392394, 14967.176805275596, 15006.474773382879, 15135.318910649048, 15150.31823567942, 5897.49871260939, 5950.256217972754, 6028.608140470856, 6060.757569697251, 6145.9692701536205, 978.5400861595039, 1006.6577363696379, 1021.274894824668, 1025.333533203409, 1048.5596049659162, 23168.4207894804, 23409.882950585477, 23465.0, 23477.765222347898, 23661.7633823663, 1094.4691824465128, 1121.7588218533056, 1135.3244819332483, 1137.5051852444212, 1145.1983611471837, 11787.29276243411, 12566.183198092094, 12595.24428534291, 12726.0, 12752.93623531895, 245323.0, 249749.0, 250240.0, 250462.0, 250827.0, 59527.702361487914, 59799.70100149558, 59870.40129598735, 59917.10124348138, 60148.0, 1490.4559835659907, 1491.5599898030107, 1497.176552895903, 1518.574799056266, 1531.3491765999406, 26568.468630627667, 28015.299617509725, 28032.29919252035, 28121.859390702917, 28418.0, 37688.43467347937, 37987.620123798406, 38100.0, 38275.42586861255, 38278.0, 179961.0, 182372.0, 182557.0, 183028.0, 183031.0, 35885.820570896976, 38361.46554137915, 39002.0, 39152.41271380874, 39284.80357598308, 45678.77160614176, 47612.047759045316, 48230.27654585254, 48265.0, 48617.5138248613, 33462.83268583739, 34355.4846677305, 34700.0, 35024.64975350214, 35436.64563354333, 32322.676773231968, 33075.0, 33540.32919341648, 33937.0, 34534.48198276978, 36277.455838162976, 38378.0, 38437.423438647886, 38577.42133867938, 38598.42102368523, 30242.0, 31856.0, 32634.0, 32876.835615821765, 33080.83459582687, 23443.648345275175, 24763.876180618983, 24829.627555586318, 25137.74862251354, 25628.231153065437], "value": 17704.188886007243, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [583.3985709228169, 584.6229182177495, 587.8677297608042, 600.8678090820018, 606.2936678769235, 21939.0, 22229.333120006384, 22715.545689086208, 22719.886400568015, 22748.88625556874, 25645.87177064112, 25899.999999999953, 26014.08950686726, 26089.608655870175, 26096.47807043863, 6554.082428460008, 6697.062411262427, 6711.798646040626, 6713.865722685543, 6717.361850624183, 5908.497777688902, 6208.875822483547, 6471.676416179196, 6502.122213501188, 6508.8047358579315, 6429.421352078312, 6434.356564343575, 6441.162648855666, 6448.065030570565, 6451.935480645204, 6424.38968298011, 6435.292117867031, 6438.323975982525, 6465.288818229991, 6489.383508566679, 5984.760609575612, 5992.9700351498395, 5997.970010149965, 6030.306514750772, 6035.637861728311, 27116.186514404402, 29244.0, 29358.85320573405, 29504.557431638543, 29896.701032989607, 1846.3999200259968, 1873.2506997201092, 1886.217219853759, 1887.3677318098453, 1898.9905050474797, 18346.26614935401, 18812.905935470237, 18976.905115474474, 18982.145803438878, 19038.0, 2359.528094381131, 2389.127968291561, 2406.0255596483453, 2419.806415486757, 2426.8786560671897, 140273.0, 143825.0, 143837.28081359525, 144076.27961860123, 144248.27875860553, 14417.42330306776, 15089.396424143131, 15151.318190681446, 15323.233838308262, 15490.380384784708, 23445.17941872026, 23857.52284954291, 23876.044958201477, 23876.880615596812, 23908.402289942544, 10211.0, 10232.130268927076, 10371.740706482398, 10404.739881502872, 10469.853679995735, 9586.0, 9638.084381983701, 9641.614335426504, 9815.460149691835, 9838.06538378853, 7729.704907558989, 9154.267658587298, 9412.67055653049, 9485.4782986935, 9502.42985420863, 2731.1396909973296, 2756.5865120232124, 2780.972190278071, 2787.4425114977084, 2834.5748137779497, 961.1781926452783, 981.7202097402206, 983.7983213441228, 989.9010098990043, 997.3567049253191, 18738.0, 19250.71123933142, 19270.518237044187, 19686.803131968783, 19752.40742777719, 981.6858605246252, 1010.2776514791959, 1029.763154474475, 1052.6157952347492, 1062.0, 10125.949370253102, 10584.100351470057, 10822.675319740263, 10846.457677116112, 11008.889911100947, 501304.0, 504446.0, 505850.0, 511707.0, 513210.0, 121786.0, 125732.37133814272, 128914.0, 129315.0, 129708.3514582421, 1265.943032563537, 1269.181378011196, 1309.9934500327438, 1313.5074347120021, 1326.4826717580152, 19552.413427597196, 20295.28966486166, 20584.883023395083, 20869.0, 21364.038618262526, 55990.0, 59530.70234648799, 60433.69783151056, 61576.384236157064, 62759.37240627535, 70225.64887175735, 70977.0, 71122.64438677774, 71250.0, 71839.28160718326, 12304.323262220305, 12959.935200323938, 13834.93082534581, 14502.492412765503, 14885.627859303604, 22712.659310110692, 23051.884740576188, 23117.537649247257, 23170.884145579163, 23262.185823496096, 17997.820021800137, 18105.456836294932, 18980.71528927095, 19079.427617171506, 19208.519787004876, 16210.918945405198, 16338.595179816415, 17173.484795456156, 17205.827941720923, 17580.296788128333, 18618.906905465385, 19360.225590976203, 20003.899980500006, 20053.495987801267, 20077.698834517203, 14543.41826326935, 14769.261536923326, 14816.777748334, 14840.332185051482, 14880.553583392515, 17571.56071098233, 18350.0, 18507.0, 18542.81457185411, 18678.906605466887], "value": 12097.244223644775, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1333.959981200564, 1396.783498557724, 1410.464023671005, 1420.1266221273913, 1426.7788492783616, 13411.59765207044, 14004.789928151073, 14053.437862485514, 14059.437622495088, 14070.507532236374, 13267.336633168352, 13858.861411385884, 14445.061071030375, 14449.78325325121, 14474.348654310556, 2606.7393260673925, 2631.6841978962552, 2665.8533780642056, 2673.211402636227, 2675.2776750277512, 2521.319243804172, 2631.460550587125, 2667.1065193160316, 2671.7194694557083, 2675.906343277986, 2608.1784237965076, 2612.203278000209, 2628.1852625686, 2657.840529568232, 2659.2819938616562, 2604.7395260473895, 2613.89544418223, 2617.9083732069475, 2642.392249782551, 2643.15419065899, 2574.382148284417, 2589.0, 2590.779783718386, 2595.4938786936555, 2596.519643865872, 13392.397342119628, 13639.659008524766, 13710.588682339545, 13722.519711810039, 13726.862731372657, 7176.569405835614, 7489.700411983514, 7496.362809161228, 7504.812379690551, 7506.699732010713, 4853.490383509751, 4985.401751789772, 4990.725510096943, 5137.614678899097, 5162.845114646567, 1730.4030109612163, 1735.4359833054182, 1736.2967997960845, 1786.490850107713, 1788.5886246163325, 22332.106715731352, 22476.55046899053, 22536.661950070764, 22545.887270563544, 22580.20969266068, 6128.3565225651555, 6281.434670879551, 6458.321876202931, 6486.383793539606, 6505.577137486048, 14786.556403307703, 15510.30203640839, 15541.45604903823, 15595.61010974712, 15631.3747450103, 7207.387372073433, 7423.851522969619, 7428.739994100289, 7465.925340746631, 7467.402607791364, 5602.299712535933, 5822.214001109881, 6035.818925432244, 6052.878942421127, 6848.315168483112, 4788.952110478851, 4834.540718631724, 4875.658703890694, 5036.118679231193, 5068.594512438996, 1324.8542660307357, 1334.0728193905336, 1337.8595247499068, 1347.5755137131773, 1369.3906211735682, 836.8200836820113, 839.9370047246481, 862.4609618988133, 888.2094935507274, 909.054583233443, 7329.670164842595, 7365.963170184222, 7407.370373518203, 7481.401487881065, 7505.737299194502, 965.1603105298435, 978.6085565773606, 1004.7437903334749, 1015.94920253987, 1035.342557476008, 5098.827269727984, 5112.9744351278005, 5149.588032957355, 5172.146595811724, 5234.712090834964, 18240.361587344378, 19240.23039078449, 19641.705374419395, 19777.604447910962, 19804.90097549503, 18945.052747362577, 18986.71519927202, 19464.70802937957, 19475.51311217231, 19535.706964395544, 10110.545025473872, 10628.681139565826, 10667.573297068031, 10731.302465339728, 10788.946055269831, 7028.929710702828, 7925.881111783213, 7956.920430795618, 8080.717174899086, 8084.919150808417, 16399.508014759576, 16630.50108496747, 16698.749518756984, 17128.229229684446, 17483.56291092733, 15774.447894323643, 17196.14019299005, 17440.651186976444, 17548.473545793648, 17598.208080636658, 10765.46172691378, 11107.0, 11669.708257293636, 11756.823647645464, 11759.588414405796, 13088.738225235633, 13194.670133246746, 13195.868041319463, 13199.802002969771, 13202.207867527979, 10336.735196963033, 10707.304025238334, 10752.0, 10912.399818009768, 10988.285761425483, 10028.24788140907, 10586.180645739218, 10702.464876756287, 10721.839172412576, 10792.784144316913, 9282.767930801514, 9717.368371055858, 9720.173785228335, 9724.805503890024, 9724.854127188239, 6774.729010839708, 6830.351116643911, 7048.823779405556, 7173.175084865307, 7214.314640109181, 7213.855722885408, 7266.418686504961, 7347.412207023533, 7349.081364829396, 7442.218567050381], "value": 6269.7277716952385, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [490.4433468013803, 509.4421608338869, 521.2259794205604, 524.45718681165, 530.5622861139561, 6219.6268223906545, 6247.937520624792, 6255.249370075586, 6266.279377871546, 6288.830353528031, 5906.61606995545, 6001.849953751147, 6031.24609423822, 6076.149339092531, 6125.08123781433, 4843.78202980865, 4847.2002119650215, 4879.097152110662, 4879.39007624047, 4899.48555401683, 4879.512048795127, 4890.070886531547, 4905.681130726509, 4915.238138088602, 4920.778564964585, 4742.217534106868, 4898.583620392271, 4911.410630724318, 4926.3842019747535, 4960.751962401883, 4889.975550122226, 4895.730734809584, 4930.309756634074, 4937.642148409181, 4940.777665005047, 4359.346098085281, 4392.143532011259, 4417.3815665806815, 4438.556144385568, 4441.822327106945, 5944.464998150144, 5982.970085149546, 5984.461398474158, 6003.759849606011, 6036.577439579231, 5625.46558076982, 5693.459121383462, 5695.231143795576, 5700.37295897451, 5708.343540492813, 6396.360363963613, 6423.87152256957, 6441.355864413568, 6489.67551622417, 6497.415232629039, 4796.328514008042, 4796.880077998043, 4832.395950506187, 4841.975790121027, 4843.505594618774, 6839.0, 6852.554583952077, 6858.485613578951, 6866.279040700754, 6881.724731010753, 4880.731559764176, 4923.261510773413, 4935.481774413706, 4940.851774446701, 4976.800927962913, 4977.925331120036, 4995.0, 5018.247262910592, 5021.548060674557, 5029.396472423333, 5654.886902261932, 5674.333063460167, 5701.173329867229, 5702.45826646468, 5711.543076553949, 6513.772017979348, 6573.94816829305, 6577.967110164419, 6628.5360024798765, 6633.6019838809825, 1646.9341226350812, 1665.933362665504, 1695.7625932369479, 1722.5951901303183, 1724.04315604838, 1183.1185766603762, 1212.7877621416394, 1219.878012198773, 1227.2145826670937, 1244.4959791284364, 5698.629589076697, 5718.79984200551, 5748.913766293509, 5755.568332375088, 5796.971015144982, 6514.348565143448, 6578.342165783383, 6588.637624930579, 6676.9332306676315, 6677.732890684319, 5743.138529220567, 5743.511801496836, 5763.3084029915835, 5788.363280039192, 5793.826185214366, 3508.4035713928693, 3553.857845686195, 3555.7866528008403, 3585.2112535242204, 3597.9280414391565, 6400.743970241138, 6465.4827613790785, 6465.903011454832, 6466.450351720063, 6501.2198536175965, 6779.525433219627, 6783.389494945479, 6786.151731033621, 6812.897806532906, 6819.24988251292, 6289.371062893765, 6346.270178929482, 6346.333634968354, 6447.323031081669, 6481.578697384655, 6497.155369802084, 6498.0, 6558.672066396565, 6595.8021259362295, 6604.471642268511, 6425.710843012169, 6482.740690372521, 6557.967210163919, 6581.0, 6588.0, 6331.430171284606, 6361.14124593174, 6428.614283143026, 6442.0, 6453.0, 4883.682560633548, 4884.926726099183, 4920.0, 4924.679895806761, 4965.230389289666, 6586.604803711601, 6613.107230523818, 6636.900446493403, 6653.700583473852, 6689.732410703712, 6449.838754031187, 6453.709583068867, 6487.870242595027, 6514.9348506514325, 6514.947791445679, 6440.0, 6498.675066246763, 6507.6746162692625, 6508.219013718195, 6513.641749703622, 5921.703914804157, 6364.459020983269, 6424.357564243538, 6435.935640643721, 6453.870922581428, 6511.270082327522, 6534.869302613826, 6575.901361479678, 6576.408123268738, 6579.605223686594, 6223.253209614694, 6338.176037115146, 6345.96827015862, 6349.460295874717, 6350.396712312323], "value": 5001.065030010356, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [922.7370199493143, 926.745145085102, 933.2487347685111, 950.1258841865483, 966.4877614864122, 18359.541011474703, 19057.52356191096, 19157.042147892604, 19254.326098586553, 22110.88944555279, 21493.355199344005, 22139.446513837163, 22274.88862555685, 22288.219912303073, 22470.0, 1027.6660085472233, 1055.0504545908705, 1055.1506037639697, 1056.234230183115, 1059.2373491086405, 1034.6275340877278, 1050.4327663061938, 1051.9158467322595, 1052.2634156090728, 1052.8157572424834, 1055.2191378379982, 1100.8403781451684, 1107.2194103157256, 1113.2485572238747, 1115.2082021764556, 1086.5327908999127, 1090.9454527273645, 1094.31058433187, 1096.0519150934424, 1098.4782228441507, 795.777182388932, 801.863683173856, 805.879118132279, 806.8587997100484, 807.8303556253194, 19519.121639526256, 19714.0, 20003.6999445007, 20023.09896054681, 20434.489137771525, 20471.18115275387, 20597.691034634492, 20816.895915520476, 21005.789942100688, 21175.894120529454, 15362.231888405535, 15466.61333466661, 15523.922380388025, 15532.0, 15604.0, 3579.3736096183325, 3601.873934412309, 3606.062423769839, 3615.710743140569, 3618.3306088373733, 116359.41820290845, 120543.0, 122365.38817305857, 126361.0, 127895.0, 16201.0, 16850.241739121768, 16889.915550422415, 16948.661026779395, 16956.067416292222, 29170.85414572956, 30776.076717698506, 30794.230144246572, 30841.845790771353, 30857.537136942963, 6684.331566843374, 6956.0, 8359.414840961075, 8719.912800872036, 8885.689000884939, 4073.307537718595, 4159.667226621863, 4161.167766446722, 4171.353440216772, 4180.581941805795, 5070.898582028339, 5163.122269214243, 5185.48145185486, 5191.9480805192225, 5196.090684130262, 1045.3414348960107, 1059.327327147267, 1061.098066643347, 1072.646026811166, 1079.3469950679882, 696.689972962027, 700.8913618389158, 709.5387997801471, 715.9248278930742, 729.595074733528, 11257.774844503065, 11598.130140239517, 11806.173567850168, 12102.455389507493, 12177.086718495972, 662.1326062857672, 673.7473447457204, 676.9593824370553, 697.1773307497101, 706.5336877660719, 5451.64564303319, 5469.343678758574, 5484.341878974548, 5634.549236061187, 5808.5933984621515, 99530.0, 101537.0, 103041.0, 105211.0, 109360.0, 86655.56672216725, 90840.0, 95128.0, 95684.52157739167, 95906.0, 77907.61046194845, 78946.6052669733, 81961.0, 84014.5799271012, 84971.0, 11076.0, 11317.264377815416, 11406.714832129263, 11751.059915206934, 12219.26684398939, 34325.65674343224, 36932.44601331036, 37424.812875935444, 37449.43825842669, 39661.2067758649, 60609.69695151496, 64630.0, 65795.67102164458, 66568.33431665815, 66850.3314966844, 18732.0, 18878.0, 18879.811201888355, 19067.904660477165, 19144.234230631177, 20959.37121886346, 21477.785222147577, 21523.677144842528, 21757.0, 22059.22792702248, 18963.715544267125, 19069.618607628046, 19093.23627054958, 19474.90262548735, 19565.119569619117, 17237.39669111575, 17422.390216342366, 17596.20817063261, 18499.260029598667, 20271.59456810885, 17818.821811782236, 19136.138873750435, 19236.903815480833, 19683.31108411199, 19739.11173997145, 13331.466741330238, 13997.930010349883, 14332.928335358256, 14388.640283992983, 14859.0, 13866.376013079638, 13918.443262269397, 14033.578992630237, 14196.0, 14760.261986900827], "value": 9168.069777629828, "unit": "score"}]}, {"extraOptions": ["e10s"], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1536.8, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [100.0, 110.0, 103.0, 109.0, 108.0, 110.0, 114.0, 102.0, 111.0, 108.0], "value": 107.5, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [154.0, 122.0, 146.0, 176.0, 119.0, 149.0, 152.0, 117.0, 173.0, 124.0], "value": 143.2, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [162.0, 162.0, 165.0, 165.0, 166.0, 162.0, 162.0, 173.0, 169.0, 167.0], "value": 165.3, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [80.0, 77.0, 76.0, 173.0, 78.0, 75.0, 83.0, 74.0, 179.0, 74.0], "value": 96.9, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [78.0, 78.0, 130.0, 80.0, 81.0, 78.0, 132.0, 79.0, 80.0, 127.0], "value": 94.3, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [113.0, 113.0, 114.0, 114.0, 114.0, 114.0, 118.0, 117.0, 117.0, 117.0], "value": 115.1, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [151.0, 151.0, 151.0, 151.0, 151.0, 150.0, 152.0, 153.0, 152.0, 151.0], "value": 151.3, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [94.0, 94.0, 94.0, 94.0, 94.0, 95.0, 95.0, 96.0, 94.0, 95.0], "value": 94.5, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [53.0, 59.0, 53.0, 54.0, 53.0, 53.0, 54.0, 53.0, 55.0, 53.0], "value": 54.0, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [55.0, 56.0, 55.0, 54.0, 55.0, 55.0, 55.0, 54.0, 56.0, 55.0], "value": 55.0, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [79.0, 88.0, 84.0, 79.0, 79.0, 77.0, 79.0, 94.0, 78.0, 77.0], "value": 81.4, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [144.0, 127.0, 129.0, 128.0, 127.0, 121.0, 122.0, 126.0, 135.0, 174.0], "value": 133.3, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [185.0, 177.0, 173.0, 176.0, 174.0, 185.0, 176.0, 173.0, 175.0, 175.0], "value": 176.9, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [69.0, 70.0, 68.0, 67.0, 67.0, 68.0, 68.0, 69.0, 68.0, 67.0], "value": 68.1, "unit": "score"}]}]} 03:21:08 INFO - Return code: 0 03:21:08 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 03:21:08 INFO - # TBPL SUCCESS # 03:21:08 INFO - Running post-action listener: _package_coverage_data 03:21:08 INFO - Running post-action listener: _resource_record_post_action 03:21:08 INFO - [mozharness: 2017-07-26 10:21:08.423070Z] Finished run-tests step (success) 03:21:08 INFO - Running post-run listener: _resource_record_post_run 03:21:08 INFO - Total resource usage - Wall time: 1194s; CPU: 13.0%; Read bytes: 20480; Write bytes: 433262592; Read time: 480; Write time: 364676 03:21:08 INFO - TinderboxPrint: CPU usage
13.2% 03:21:08 INFO - TinderboxPrint: I/O read bytes / time
20,480 / 480 03:21:08 INFO - TinderboxPrint: I/O write bytes / time
433,262,592 / 364,676 03:21:08 INFO - TinderboxPrint: CPU idle
8,266.1 (86.8%) 03:21:08 INFO - TinderboxPrint: CPU user
1,202.5 (12.6%) 03:21:08 INFO - TinderboxPrint: Swap in / out
0 / 0 03:21:08 INFO - install - Wall time: 18s; CPU: 13.0%; Read bytes: 4096; Write bytes: 106975232; Read time: 36; Write time: 132692 03:21:08 INFO - setup-mitmproxy - Wall time: 0s; CPU: Can't collect data; Read bytes: 0; Write bytes: 0; Read time: 0; Write time: 0 03:21:08 INFO - run-tests - Wall time: 1177s; CPU: 13.0%; Read bytes: 12288; Write bytes: 325165056; Read time: 432; Write time: 231932 03:21:09 INFO - Running post-run listener: _upload_blobber_files 03:21:09 INFO - Blob upload gear active. 03:21:09 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 03:21:09 INFO - Files from /builds/slave/test/build/blobber_upload_dir are to be uploaded with branch at the following location(s): https://blobupload.elasticbeanstalk.com 03:21:09 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test/oauth.txt', '-b', 'Firefox', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 03:21:09 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test/oauth.txt -b Firefox -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 03:21:09 INFO - (blobuploader) - INFO - Open directory for files ... 03:21:09 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/perfherder-data.json ... 03:21:09 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 03:21:09 INFO - (blobuploader) - INFO - Uploading, attempt #1. 03:21:10 INFO - (blobuploader) - INFO - TinderboxPrint: perfherder-data.json: uploaded 03:21:10 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 03:21:10 INFO - (blobuploader) - INFO - Done attempting. 03:21:10 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 03:21:10 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 03:21:10 INFO - (blobuploader) - INFO - Uploading, attempt #1. 03:21:13 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 03:21:13 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 03:21:13 INFO - (blobuploader) - INFO - Done attempting. 03:21:13 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 03:21:13 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 03:21:13 INFO - (blobuploader) - INFO - Uploading, attempt #1. 03:21:14 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 03:21:14 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 03:21:14 INFO - (blobuploader) - INFO - Done attempting. 03:21:14 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 03:21:14 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 03:21:14 INFO - (blobuploader) - INFO - Uploading, attempt #1. 03:21:15 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 03:21:15 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 03:21:15 INFO - (blobuploader) - INFO - Done attempting. 03:21:15 INFO - (blobuploader) - INFO - Iteration through files over. 03:21:15 INFO - Return code: 0 03:21:15 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 03:21:15 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 03:21:15 INFO - Setting buildbot property blobber_files to {"perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/c52fc3bbc7f4a70ee45cd883116337933dc7f7e446655f67309d66fba433bb92f945dce52e5291671c63aff91a14d790bf5f93e8a72d8d4d1f6dab86f5567b40", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/e6bbe08d0af424061efe6ff1abaffd9e94eb72322529952b92cd1a70cc02fba87eefbde845e1f3b7744d231972db25285386a9051cbb06f0a31acda853122afe", "dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/938ca70c4b87edc58fc3a47a9bcb5ada5f79df07757b2029a122d4e588c6289fcabc0247ae6a42eb5c350da81c1cfa47ebe2c732a4c691a4e311e8724683e775", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/3dbc14716fbd10f4194caba47ebff8545fdb2319a5825f721c1feb8a10443cd52ebb5fbe7429e90644fd1f2a376a4ef78d38142ea8d3a14cec747b67e4cbc252"} 03:21:15 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 03:21:15 INFO - Writing to file /builds/slave/test/properties/blobber_files 03:21:15 INFO - Contents: 03:21:15 INFO - blobber_files:{"perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/c52fc3bbc7f4a70ee45cd883116337933dc7f7e446655f67309d66fba433bb92f945dce52e5291671c63aff91a14d790bf5f93e8a72d8d4d1f6dab86f5567b40", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/e6bbe08d0af424061efe6ff1abaffd9e94eb72322529952b92cd1a70cc02fba87eefbde845e1f3b7744d231972db25285386a9051cbb06f0a31acda853122afe", "dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/938ca70c4b87edc58fc3a47a9bcb5ada5f79df07757b2029a122d4e588c6289fcabc0247ae6a42eb5c350da81c1cfa47ebe2c732a4c691a4e311e8724683e775", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/3dbc14716fbd10f4194caba47ebff8545fdb2319a5825f721c1feb8a10443cd52ebb5fbe7429e90644fd1f2a376a4ef78d38142ea8d3a14cec747b67e4cbc252"} 03:21:15 INFO - Running post-run listener: copy_logs_to_upload_dir 03:21:15 INFO - Copying logs to upload dir... 03:21:15 INFO - mkdir: /builds/slave/test/build/upload/logs 03:21:15 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1253.049980 ========= master_lag: 0.03 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 53 secs) (at 2017-07-26 03:21:14.926713) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-07-26 03:21:14.931865) ========= bash -c 'for file in `ls -1`; do cat $file; done' in dir /builds/slave/test/properties (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'for file in `ls -1`; do cat $file; done'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test/properties SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=934fc3100db09dcb9af4d4b6000001ab-1501060803.338282-617044629 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/c52fc3bbc7f4a70ee45cd883116337933dc7f7e446655f67309d66fba433bb92f945dce52e5291671c63aff91a14d790bf5f93e8a72d8d4d1f6dab86f5567b40", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/e6bbe08d0af424061efe6ff1abaffd9e94eb72322529952b92cd1a70cc02fba87eefbde845e1f3b7744d231972db25285386a9051cbb06f0a31acda853122afe", "dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/938ca70c4b87edc58fc3a47a9bcb5ada5f79df07757b2029a122d4e588c6289fcabc0247ae6a42eb5c350da81c1cfa47ebe2c732a4c691a4e311e8724683e775", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/3dbc14716fbd10f4194caba47ebff8545fdb2319a5825f721c1feb8a10443cd52ebb5fbe7429e90644fd1f2a376a4ef78d38142ea8d3a14cec747b67e4cbc252"} build_url:https://queue.taskcluster.net/v1/task/IWL1hFHuQNKITtjZ11Me9g/artifacts/public/build/target.tar.bz2 program finished with exit code 0 elapsedTime=0.011240 build_url: 'https://queue.taskcluster.net/v1/task/IWL1hFHuQNKITtjZ11Me9g/artifacts/public/build/target.tar.bz2' blobber_files: '{"perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/c52fc3bbc7f4a70ee45cd883116337933dc7f7e446655f67309d66fba433bb92f945dce52e5291671c63aff91a14d790bf5f93e8a72d8d4d1f6dab86f5567b40", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/e6bbe08d0af424061efe6ff1abaffd9e94eb72322529952b92cd1a70cc02fba87eefbde845e1f3b7744d231972db25285386a9051cbb06f0a31acda853122afe", "dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/938ca70c4b87edc58fc3a47a9bcb5ada5f79df07757b2029a122d4e588c6289fcabc0247ae6a42eb5c350da81c1cfa47ebe2c732a4c691a4e311e8724683e775", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/3dbc14716fbd10f4194caba47ebff8545fdb2319a5825f721c1feb8a10443cd52ebb5fbe7429e90644fd1f2a376a4ef78d38142ea8d3a14cec747b67e4cbc252"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-07-26 03:21:14.963770) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-07-26 03:21:14.964200) ========= rm -f oauth.txt in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-f', 'oauth.txt'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=934fc3100db09dcb9af4d4b6000001ab-1501060803.338282-617044629 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004473 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-07-26 03:21:15.048340) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2017-07-26 03:21:15.048783) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2017-07-26 03:21:15.049150) ========= ========= Total master_lag: 0.19 =========