builder: mozilla-central_ubuntu64_hw_stylo_test-dromaeojs-e10s slave: talos-linux64-ix-030 starttime: 1499685101.67 results: success (0) revision: bd802b54879e64c786754b9931c2a3a505119da9 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2017-07-10 04:11:41.669247) ========= master: http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2017-07-10 04:11:41.669699) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-07-10 04:11:41.669968) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-07-10 04:11:41.685609) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-07-10 04:11:41.685873) ========= 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=3836458cccd887f2d2de3cf1000001de-1499671981.326684-287146855 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2017-07-10 04:11:42-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.102, 63.245.215.25 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.102|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12179 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 40.6M=0s 2017-07-10 04:11:42 (40.6 MB/s) - `archiver_client.py' saved [12179/12179] program finished with exit code 0 elapsedTime=0.142682 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-07-10 04:11:41.848518) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-07-10 04:11:41.848819) ========= 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=3836458cccd887f2d2de3cf1000001de-1499671981.326684-287146855 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.023060 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-07-10 04:11:41.902685) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-07-10 04:11:41.902978) ========= bash -c 'python archiver_client.py mozharness --repo mozilla-central --rev bd802b54879e64c786754b9931c2a3a505119da9 --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 bd802b54879e64c786754b9931c2a3a505119da9 --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=3836458cccd887f2d2de3cf1000001de-1499671981.326684-287146855 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2017-07-10 04:11:42,360 truncating revision to first 12 chars 2017-07-10 04:11:42,360 Setting DEBUG logging. 2017-07-10 04:11:42,360 attempt 1/10 2017-07-10 04:11:42,360 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/mozilla-central/bd802b54879e?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2017-07-10 04:11:42,711 unpacking tar archive at: mozilla-central-bd802b54879e/testing/mozharness/ program finished with exit code 0 elapsedTime=0.662935 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-07-10 04:11:42.580534) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-07-10 04:11:42.580810) ========= script_repo_revision: bd802b54879e64c786754b9931c2a3a505119da9 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-07-10 04:11:42.581176) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-07-10 04:11:42.584467) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-07-10 04:11:42.593720) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 20 secs) (at 2017-07-10 04:11:42.593993) ========= /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=3836458cccd887f2d2de3cf1000001de-1499671981.326684-287146855 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 04:11:43 INFO - MultiFileLogger online at 20170710 04:11:43 in /builds/slave/test 04:11:43 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 04:11:43 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 04:11:43 INFO - {'append_to_log': False, 04:11:43 INFO - 'base_work_dir': '/builds/slave/test', 04:11:43 INFO - 'blob_upload_branch': 'Firefox', 04:11:43 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 04:11:43 INFO - 'branch': 'Firefox', 04:11:43 INFO - 'buildbot_json_path': 'buildprops.json', 04:11:43 INFO - 'code_coverage': False, 04:11:43 INFO - 'config_files': ('talos/linux_config.py',), 04:11:43 INFO - 'default_actions': ('clobber', 04:11:43 INFO - 'read-buildbot-config', 04:11:43 INFO - 'download-and-extract', 04:11:43 INFO - 'populate-webroot', 04:11:43 INFO - 'create-virtualenv', 04:11:43 INFO - 'install', 04:11:43 INFO - 'setup-mitmproxy', 04:11:43 INFO - 'run-tests'), 04:11:43 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 04:11:43 INFO - 'disable_ccov_upload': False, 04:11:43 INFO - 'download_minidump_stackwalk': True, 04:11:43 INFO - 'download_symbols': 'ondemand', 04:11:43 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 04:11:43 INFO - 'tooltool.py': '/tools/tooltool.py', 04:11:43 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 04:11:43 INFO - '/tools/misc-python/virtualenv.py')}, 04:11:43 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 04:11:43 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 04:11:43 INFO - 'gecko_profile': False, 04:11:43 INFO - 'gecko_profile_interval': 0, 04:11:43 INFO - 'installer_path': 'installer.exe', 04:11:43 INFO - 'log_level': 'info', 04:11:43 INFO - 'log_name': 'talos', 04:11:43 INFO - 'log_to_console': True, 04:11:43 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 04:11:43 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 04:11:43 INFO - 'opt_config_files': (), 04:11:43 INFO - 'pip_index': False, 04:11:43 INFO - 'suite': 'dromaeojs-e10s', 04:11:43 INFO - 'system_bits': '32', 04:11:43 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 04:11:43 INFO - 'title': 'talos-linux64-ix-030', 04:11:43 INFO - 'tooltool_cache': '/builds/tooltool_cache', 04:11:43 INFO - 'use_talos_json': True, 04:11:43 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 04:11:43 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 04:11:43 INFO - 'work_dir': 'build'} 04:11:43 INFO - [mozharness: 2017-07-10 11:11:43.154624Z] Running clobber step. 04:11:43 INFO - Running pre-action listener: _resource_record_pre_action 04:11:43 INFO - Running main action method: clobber 04:11:43 INFO - rmtree: /builds/slave/test/build 04:11:43 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 04:11:44 INFO - Running post-action listener: _resource_record_post_action 04:11:44 INFO - [mozharness: 2017-07-10 11:11:44.723938Z] Finished clobber step (success) 04:11:44 INFO - [mozharness: 2017-07-10 11:11:44.724040Z] Running read-buildbot-config step. 04:11:44 INFO - Running pre-action listener: _resource_record_pre_action 04:11:44 INFO - Running main action method: read_buildbot_config 04:11:44 INFO - Using buildbot properties: 04:11:44 INFO - { 04:11:44 INFO - "project": "", 04:11:44 INFO - "product": "firefox", 04:11:44 INFO - "who": "cbook@mozilla.com", 04:11:44 INFO - "installer_path": "public/build/target.tar.bz2", 04:11:44 INFO - "builddir": "mozilla-central_ubuntu64_hw_stylo_test-dromaeojs-e10s", 04:11:44 INFO - "repository": "https://hg.mozilla.org/mozilla-central/", 04:11:44 INFO - "buildername": "Ubuntu HW 12.04 x64 stylo mozilla-central talos dromaeojs-e10s", 04:11:44 INFO - "stage_platform": "linux64-stylo", 04:11:44 INFO - "basedir": "/builds/slave/test", 04:11:44 INFO - "buildnumber": 193, 04:11:44 INFO - "platform": "ubuntu64_hw_stylo", 04:11:44 INFO - "master": "http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/", 04:11:44 INFO - "slavebuilddir": "test", 04:11:44 INFO - "taskId": "NHUIKfyFQx66CAa5huXFkg", 04:11:44 INFO - "branch": "mozilla-central", 04:11:44 INFO - "script_repo_revision": "production", 04:11:44 INFO - "revision": "bd802b54879e64c786754b9931c2a3a505119da9", 04:11:44 INFO - "slavename": "talos-linux64-ix-030", 04:11:44 INFO - "repo_path": "mozilla-central" 04:11:44 INFO - } 04:11:44 INFO - Finding installer, test and symbols from parent task. 04:11:44 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/NHUIKfyFQx66CAa5huXFkg'}, attempt #1 04:11:45 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/NHUIKfyFQx66CAa5huXFkg'}, attempt #1 04:11:45 INFO - Task dependencies: aA7Yn3CFSGWrt0-fZEf0Jw 04:11:45 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/aA7Yn3CFSGWrt0-fZEf0Jw'}, attempt #1 04:11:46 INFO - Set installer_url: https://queue.taskcluster.net/v1/task/aA7Yn3CFSGWrt0-fZEf0Jw/artifacts/public/build/target.tar.bz2 04:11:46 INFO - Set test_url: https://queue.taskcluster.net/v1/task/aA7Yn3CFSGWrt0-fZEf0Jw/artifacts/public/build/test_packages.json 04:11:46 INFO - Set symbols_url: https://queue.taskcluster.net/v1/task/aA7Yn3CFSGWrt0-fZEf0Jw/artifacts/public/build/target.crashreporter-symbols.zip 04:11:46 INFO - Running post-action listener: _resource_record_post_action 04:11:46 INFO - [mozharness: 2017-07-10 11:11:46.116848Z] Finished read-buildbot-config step (success) 04:11:46 INFO - [mozharness: 2017-07-10 11:11:46.117070Z] Running download-and-extract step. 04:11:46 INFO - Running pre-action listener: _resource_record_pre_action 04:11:46 INFO - Running main action method: download_and_extract 04:11:46 INFO - mkdir: /builds/slave/test/build/tests 04:11:46 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')]} 04:11:46 INFO - trying https://queue.taskcluster.net/v1/task/aA7Yn3CFSGWrt0-fZEf0Jw/artifacts/public/build/target.test_packages.json 04:11:46 INFO - Downloading https://queue.taskcluster.net/v1/task/aA7Yn3CFSGWrt0-fZEf0Jw/artifacts/public/build/target.test_packages.json to /builds/slave/test/build/target.test_packages.json 04:11:46 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/aA7Yn3CFSGWrt0-fZEf0Jw/artifacts/public/build/target.test_packages.json', 'file_name': '/builds/slave/test/build/target.test_packages.json'}, attempt #1 04:11:46 INFO - Downloaded 989 bytes. 04:11:46 INFO - Reading from file /builds/slave/test/build/target.test_packages.json 04:11:46 INFO - Using the following test package requirements: 04:11:46 INFO - {u'awsy': [u'target.common.tests.zip', u'target.awsy.tests.zip'], 04:11:46 INFO - u'common': [u'target.common.tests.zip'], 04:11:46 INFO - u'cppunittest': [u'target.common.tests.zip', u'target.cppunittest.tests.zip'], 04:11:46 INFO - u'gtest': [u'target.common.tests.zip', u'target.gtest.tests.zip'], 04:11:46 INFO - u'jittest': [u'target.common.tests.zip', u'target.jsshell.zip'], 04:11:46 INFO - u'mochitest': [u'target.common.tests.zip', u'target.mochitest.tests.zip'], 04:11:46 INFO - u'mozbase': [u'target.common.tests.zip'], 04:11:46 INFO - u'reftest': [u'target.common.tests.zip', u'target.reftest.tests.zip'], 04:11:46 INFO - u'talos': [u'target.common.tests.zip', u'target.talos.tests.zip'], 04:11:46 INFO - u'web-platform': [u'target.common.tests.zip', 04:11:46 INFO - u'target.web-platform.tests.tar.gz'], 04:11:46 INFO - u'xpcshell': [u'target.common.tests.zip', u'target.xpcshell.tests.zip']} 04:11:46 INFO - Downloading packages: [u'target.common.tests.zip'] for test suite category: common 04:11:46 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/aA7Yn3CFSGWrt0-fZEf0Jw/artifacts/public/build/target.common.tests.zip 04:11:46 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/aA7Yn3CFSGWrt0-fZEf0Jw/artifacts/public/build/target.common.tests.zip'}, attempt #1 04:11:46 INFO - Fetch https://queue.taskcluster.net/v1/task/aA7Yn3CFSGWrt0-fZEf0Jw/artifacts/public/build/target.common.tests.zip into memory 04:11:47 INFO - Content-Length response header: 67424107 04:11:47 INFO - Bytes received: 67424107 04:11:58 INFO - Downloading packages: [u'target.common.tests.zip', u'target.talos.tests.zip'] for test suite category: talos 04:11:58 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/aA7Yn3CFSGWrt0-fZEf0Jw/artifacts/public/build/target.common.tests.zip 04:11:58 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/aA7Yn3CFSGWrt0-fZEf0Jw/artifacts/public/build/target.common.tests.zip'}, attempt #1 04:11:58 INFO - Fetch https://queue.taskcluster.net/v1/task/aA7Yn3CFSGWrt0-fZEf0Jw/artifacts/public/build/target.common.tests.zip into memory 04:11:59 INFO - Content-Length response header: 67424107 04:11:59 INFO - Bytes received: 67424107 04:12:12 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/aA7Yn3CFSGWrt0-fZEf0Jw/artifacts/public/build/target.talos.tests.zip 04:12:12 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/aA7Yn3CFSGWrt0-fZEf0Jw/artifacts/public/build/target.talos.tests.zip'}, attempt #1 04:12:12 INFO - Fetch https://queue.taskcluster.net/v1/task/aA7Yn3CFSGWrt0-fZEf0Jw/artifacts/public/build/target.talos.tests.zip into memory 04:12:12 INFO - Content-Length response header: 14473968 04:12:12 INFO - Bytes received: 14473968 04:12: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')]} 04:12:13 INFO - trying https://queue.taskcluster.net/v1/task/aA7Yn3CFSGWrt0-fZEf0Jw/artifacts/public/build/target.tar.bz2 04:12:13 INFO - Downloading https://queue.taskcluster.net/v1/task/aA7Yn3CFSGWrt0-fZEf0Jw/artifacts/public/build/target.tar.bz2 to /builds/slave/test/build/target.tar.bz2 04:12:13 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/aA7Yn3CFSGWrt0-fZEf0Jw/artifacts/public/build/target.tar.bz2', 'file_name': '/builds/slave/test/build/target.tar.bz2'}, attempt #1 04:12:14 INFO - Downloaded 61952121 bytes. 04:12:14 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/aA7Yn3CFSGWrt0-fZEf0Jw/artifacts/public/build/target.tar.bz2 04:12:14 INFO - mkdir: /builds/slave/test/properties 04:12:14 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 04:12:14 INFO - Writing to file /builds/slave/test/properties/build_url 04:12:14 INFO - Contents: 04:12:14 INFO - build_url:https://queue.taskcluster.net/v1/task/aA7Yn3CFSGWrt0-fZEf0Jw/artifacts/public/build/target.tar.bz2 04:12:14 INFO - Running post-action listener: _resource_record_post_action 04:12:14 INFO - Running post-action listener: set_extra_try_arguments 04:12:14 INFO - [mozharness: 2017-07-10 11:12:14.395076Z] Finished download-and-extract step (success) 04:12:14 INFO - [mozharness: 2017-07-10 11:12:14.395266Z] Running populate-webroot step. 04:12:14 INFO - Running pre-action listener: _resource_record_pre_action 04:12:14 INFO - Running main action method: populate_webroot 04:12:14 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 04:12:14 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 04:12:14 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 04:12:14 INFO - '--tppagecycles', 04:12:14 INFO - '7'], 04:12:14 INFO - 'tests': ['tsvgm']}}, 04:12:14 INFO - 'suites': {'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 04:12:14 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 04:12:14 INFO - 'tests': ['dromaeo_css', 'kraken']}, 04:12:14 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 04:12:14 INFO - 'g1': {'pagesets_name': 'tp5n.zip', 04:12:14 INFO - 'talos_options': ['--disable-e10s'], 04:12:14 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 04:12:14 INFO - 'g1-e10s': {'pagesets_name': 'tp5n.zip', 04:12:14 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 04:12:14 INFO - 'g2': {'pagesets_name': 'tp5n.zip', 04:12:14 INFO - 'talos_options': ['--disable-e10s'], 04:12:14 INFO - 'tests': ['damp', 'tps']}, 04:12:14 INFO - 'g2-e10s': {'pagesets_name': 'tp5n.zip', 04:12:14 INFO - 'tests': ['damp', 'tps']}, 04:12:14 INFO - 'g3': {'talos_options': ['--disable-e10s'], 04:12:14 INFO - 'tests': ['dromaeo_dom']}, 04:12:14 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 04:12:14 INFO - 'g4': {'talos_options': ['--disable-e10s'], 04:12:14 INFO - 'tests': ['basic_compositor_video', 'glvideo']}, 04:12:14 INFO - 'g4-e10s': {'tests': ['basic_compositor_video', 'glvideo']}, 04:12:14 INFO - 'g5-e10s': {'pagesets_name': 'tp5n.zip', 04:12:14 INFO - 'tests': ['ts_paint_webext', 'tp5o_webext']}, 04:12:14 INFO - 'other': {'talos_options': ['--disable-e10s'], 04:12:14 INFO - 'tests': ['a11yr', 04:12:14 INFO - 'ts_paint', 04:12:14 INFO - 'tpaint', 04:12:14 INFO - 'sessionrestore', 04:12:14 INFO - 'sessionrestore_no_auto_restore', 04:12:14 INFO - 'tabpaint']}, 04:12:14 INFO - 'other-e10s': {'tests': ['a11yr', 04:12:14 INFO - 'ts_paint', 04:12:14 INFO - 'tpaint', 04:12:14 INFO - 'sessionrestore', 04:12:14 INFO - 'sessionrestore_many_windows', 04:12:14 INFO - 'sessionrestore_no_auto_restore', 04:12:14 INFO - 'tabpaint']}, 04:12:14 INFO - 'other-e10s_l64': {'tests': ['a11yr', 04:12:14 INFO - 'ts_paint', 04:12:14 INFO - 'tpaint', 04:12:14 INFO - 'sessionrestore', 04:12:14 INFO - 'sessionrestore_many_windows', 04:12:14 INFO - 'sessionrestore_no_auto_restore', 04:12:14 INFO - 'tabpaint']}, 04:12:14 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 04:12:14 INFO - 'ts_paint', 04:12:14 INFO - 'tpaint', 04:12:14 INFO - 'sessionrestore', 04:12:14 INFO - 'sessionrestore_many_windows', 04:12:14 INFO - 'sessionrestore_no_auto_restore', 04:12:14 INFO - 'tabpaint']}, 04:12:14 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 04:12:14 INFO - 'tests': ['a11yr', 04:12:14 INFO - 'ts_paint', 04:12:14 INFO - 'tpaint', 04:12:14 INFO - 'sessionrestore', 04:12:14 INFO - 'sessionrestore_no_auto_restore', 04:12:14 INFO - 'tabpaint']}, 04:12:14 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 04:12:14 INFO - 'tests': ['a11yr', 04:12:14 INFO - 'ts_paint', 04:12:14 INFO - 'tpaint', 04:12:14 INFO - 'sessionrestore', 04:12:14 INFO - 'sessionrestore_no_auto_restore', 04:12:14 INFO - 'tabpaint']}, 04:12:14 INFO - 'perf-reftest': {'tests': ['bloom_basic']}, 04:12:14 INFO - 'perf-reftest-e10s': {'tests': ['bloom_basic']}, 04:12:14 INFO - 'perf-reftest-singletons-e10s': {'tests': ['bloom_basic_singleton']}, 04:12:14 INFO - 'quantum-pageload-e10s': {'mitmproxy_recording_set': 'mitmproxy-recording-set-win10.zip', 04:12:14 INFO - 'talos_options': ['--mitmproxy', 04:12:14 INFO - 'mitmproxy-recording-google.mp mitmproxy-recording-youtube.mp mitmproxy-recording-amazon.mp mitmproxy-recording-facebook.mp', 04:12:14 INFO - '--firstNonBlankPaint'], 04:12:14 INFO - 'tests': ['quantum_pageload_google', 04:12:14 INFO - 'quantum_pageload_youtube', 04:12:14 INFO - 'quantum_pageload_amazon', 04:12:14 INFO - 'quantum_pageload_facebook']}, 04:12:14 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 04:12:14 INFO - 'tests': ['tsvgx', 04:12:14 INFO - 'tsvgr_opacity', 04:12:14 INFO - 'tart', 04:12:14 INFO - 'tscrollx', 04:12:14 INFO - 'cart', 04:12:14 INFO - 'tsvg_static']}, 04:12:14 INFO - 'svgr-e10s': {'tests': ['tsvgx', 04:12:14 INFO - 'tsvgr_opacity', 04:12:14 INFO - 'tart', 04:12:14 INFO - 'tscrollx', 04:12:14 INFO - 'cart', 04:12:14 INFO - 'tsvg_static']}, 04:12:14 INFO - 'tp5o': {'pagesets_name': 'tp5n.zip', 04:12:14 INFO - 'talos_options': ['--disable-e10s'], 04:12:14 INFO - 'tests': ['tp5o']}, 04:12:14 INFO - 'tp5o-e10s': {'pagesets_name': 'tp5n.zip', 'tests': ['tp5o']}, 04:12:14 INFO - 'xperf': {'pagesets_name': 'tp5n.zip', 04:12:14 INFO - 'talos_options': ['--disable-e10s', 04:12:14 INFO - '--xperf_path', 04:12:14 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 04:12:14 INFO - 'tests': ['tp5n']}, 04:12:14 INFO - 'xperf-e10s': {'pagesets_name': 'tp5n.zip', 04:12:14 INFO - 'talos_options': ['--xperf_path', 04:12:14 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 04:12:14 INFO - 'tests': ['tp5n']}}, 04:12:14 INFO - 'talos.zip': {'path': '', 04:12:14 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 04:12:14 INFO - Running post-action listener: _resource_record_post_action 04:12:14 INFO - [mozharness: 2017-07-10 11:12:14.414046Z] Finished populate-webroot step (success) 04:12:14 INFO - [mozharness: 2017-07-10 11:12:14.414138Z] Running create-virtualenv step. 04:12:14 INFO - Running pre-action listener: _resource_record_pre_action 04:12:14 INFO - Running main action method: create_virtualenv 04:12:14 INFO - Creating virtualenv /builds/slave/test/build/venv 04:12:14 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 04:12:14 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 04:12:14 INFO - Using partial env: {'VIRTUALENV_NO_DOWNLOAD': '1'} 04:12:14 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 04:12:14 INFO - Using real prefix '/usr' 04:12:14 INFO - New python executable in /builds/slave/test/build/venv/bin/python 04:12:15 INFO - Installing distribute.............................................................................................................................................................................................done. 04:12:16 INFO - Installing pip.................done. 04:12:16 INFO - Return code: 0 04:12:16 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', '--version'] 04:12:16 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip --version 04:12:17 INFO - Reading from file tmpfile_stdout 04:12:17 INFO - Output received: 04:12:17 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) 04:12:17 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 04:12:17 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')]} 04:12:17 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:12:17 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')]} 04:12:17 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:12:17 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 0xf591f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1125a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x12c8fa0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x12cc2a0>, '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 0x12cd2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x12c74d0>, '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': '3836458cccd887f2d2de3cf1000001de-1499671981.326684-287146855', '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 04:12:17 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 04:12:17 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 04:12:17 INFO - Using env: {'DISPLAY': ':0', 04:12:17 INFO - 'HOME': '/home/cltbld', 04:12:17 INFO - 'LANG': 'en_US.UTF-8', 04:12:17 INFO - 'LANGUAGE': 'en_US:en', 04:12:17 INFO - 'LOGNAME': 'cltbld', 04:12:17 INFO - 'MAIL': '/var/mail/cltbld', 04:12:17 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:12:17 INFO - 'MOZ_NO_REMOTE': '1', 04:12:17 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:12:17 INFO - 'NO_EM_RESTART': '1', 04:12:17 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:12:17 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:12:17 INFO - 'PWD': '/builds/slave/test', 04:12:17 INFO - 'SHELL': '/bin/bash', 04:12:17 INFO - 'SHLVL': '1', 04:12:17 INFO - 'TERM': 'linux', 04:12:17 INFO - 'TMOUT': '86400', 04:12:17 INFO - 'USER': 'cltbld', 04:12:17 INFO - 'XDG_SESSION_COOKIE': '3836458cccd887f2d2de3cf1000001de-1499671981.326684-287146855', 04:12:17 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:12:17 INFO - '_': '/tools/buildbot/bin/python'} 04:12:17 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:12:17 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 04:12:17 INFO - Cleaning up... 04:12:17 INFO - Return code: 0 04:12:17 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 04:12:17 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')]} 04:12:17 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:12:17 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')]} 04:12:17 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:12:17 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 0xf591f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1125a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x12c8fa0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x12cc2a0>, '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 0x12cd2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x12c74d0>, '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': '3836458cccd887f2d2de3cf1000001de-1499671981.326684-287146855', '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 04:12:17 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 04:12:17 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 04:12:17 INFO - Using env: {'DISPLAY': ':0', 04:12:17 INFO - 'HOME': '/home/cltbld', 04:12:17 INFO - 'LANG': 'en_US.UTF-8', 04:12:17 INFO - 'LANGUAGE': 'en_US:en', 04:12:17 INFO - 'LOGNAME': 'cltbld', 04:12:17 INFO - 'MAIL': '/var/mail/cltbld', 04:12:17 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:12:17 INFO - 'MOZ_NO_REMOTE': '1', 04:12:17 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:12:17 INFO - 'NO_EM_RESTART': '1', 04:12:17 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:12:17 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:12:17 INFO - 'PWD': '/builds/slave/test', 04:12:17 INFO - 'SHELL': '/bin/bash', 04:12:17 INFO - 'SHLVL': '1', 04:12:17 INFO - 'TERM': 'linux', 04:12:17 INFO - 'TMOUT': '86400', 04:12:17 INFO - 'USER': 'cltbld', 04:12:17 INFO - 'XDG_SESSION_COOKIE': '3836458cccd887f2d2de3cf1000001de-1499671981.326684-287146855', 04:12:17 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:12:17 INFO - '_': '/tools/buildbot/bin/python'} 04:12:17 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:12:17 INFO - Downloading/unpacking psutil>=3.1.1 04:12:17 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 04:12:17 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 04:12:17 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 04:12:17 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 04:12:18 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 04:12:18 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 04:12:18 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 04:12:18 INFO - Installing collected packages: psutil 04:12:18 INFO - Running setup.py install for psutil 04:12:18 INFO - building 'psutil._psutil_linux' extension 04:12:18 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 04:12:19 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 04:12:19 INFO - building 'psutil._psutil_posix' extension 04:12:19 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 04:12:19 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 04:12:19 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 04:12:19 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 04:12:19 INFO - Successfully installed psutil 04:12:19 INFO - Cleaning up... 04:12:19 INFO - Return code: 0 04:12:19 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 04:12:19 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')]} 04:12:19 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:12:19 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')]} 04:12:19 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:12:19 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 0xf591f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1125a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x12c8fa0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x12cc2a0>, '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 0x12cd2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x12c74d0>, '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': '3836458cccd887f2d2de3cf1000001de-1499671981.326684-287146855', '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 04:12:19 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 04:12:19 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 04:12:19 INFO - Using env: {'DISPLAY': ':0', 04:12:19 INFO - 'HOME': '/home/cltbld', 04:12:19 INFO - 'LANG': 'en_US.UTF-8', 04:12:19 INFO - 'LANGUAGE': 'en_US:en', 04:12:19 INFO - 'LOGNAME': 'cltbld', 04:12:19 INFO - 'MAIL': '/var/mail/cltbld', 04:12:19 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:12:19 INFO - 'MOZ_NO_REMOTE': '1', 04:12:19 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:12:19 INFO - 'NO_EM_RESTART': '1', 04:12:19 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:12:19 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:12:19 INFO - 'PWD': '/builds/slave/test', 04:12:19 INFO - 'SHELL': '/bin/bash', 04:12:19 INFO - 'SHLVL': '1', 04:12:19 INFO - 'TERM': 'linux', 04:12:19 INFO - 'TMOUT': '86400', 04:12:19 INFO - 'USER': 'cltbld', 04:12:19 INFO - 'XDG_SESSION_COOKIE': '3836458cccd887f2d2de3cf1000001de-1499671981.326684-287146855', 04:12:19 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:12:19 INFO - '_': '/tools/buildbot/bin/python'} 04:12:19 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:12:19 INFO - Downloading/unpacking mozsystemmonitor==0.3 04:12:19 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 04:12:19 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 04:12:19 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 04:12:19 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 04:12:20 INFO - Downloading mozsystemmonitor-0.3.tar.gz 04:12:20 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 04:12:20 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 04:12:20 INFO - Installing collected packages: mozsystemmonitor 04:12:20 INFO - Running setup.py install for mozsystemmonitor 04:12:20 INFO - Successfully installed mozsystemmonitor 04:12:20 INFO - Cleaning up... 04:12:20 INFO - Return code: 0 04:12:20 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 04:12:20 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')]} 04:12:20 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:12:20 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')]} 04:12:20 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:12:20 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 0xf591f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1125a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x12c8fa0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x12cc2a0>, '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 0x12cd2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x12c74d0>, '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': '3836458cccd887f2d2de3cf1000001de-1499671981.326684-287146855', '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 04:12:20 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 04:12:20 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 04:12:20 INFO - Using env: {'DISPLAY': ':0', 04:12:20 INFO - 'HOME': '/home/cltbld', 04:12:20 INFO - 'LANG': 'en_US.UTF-8', 04:12:20 INFO - 'LANGUAGE': 'en_US:en', 04:12:20 INFO - 'LOGNAME': 'cltbld', 04:12:20 INFO - 'MAIL': '/var/mail/cltbld', 04:12:20 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:12:20 INFO - 'MOZ_NO_REMOTE': '1', 04:12:20 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:12:20 INFO - 'NO_EM_RESTART': '1', 04:12:20 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:12:20 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:12:20 INFO - 'PWD': '/builds/slave/test', 04:12:20 INFO - 'SHELL': '/bin/bash', 04:12:20 INFO - 'SHLVL': '1', 04:12:20 INFO - 'TERM': 'linux', 04:12:20 INFO - 'TMOUT': '86400', 04:12:20 INFO - 'USER': 'cltbld', 04:12:20 INFO - 'XDG_SESSION_COOKIE': '3836458cccd887f2d2de3cf1000001de-1499671981.326684-287146855', 04:12:20 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:12:20 INFO - '_': '/tools/buildbot/bin/python'} 04:12:21 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:12:21 INFO - Downloading/unpacking jsonschema==2.5.1 04:12:21 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 04:12:21 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 04:12:21 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 04:12:21 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 04:12:22 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 04:12:22 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 04:12:22 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 04:12:22 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 04:12:22 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 04:12:22 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 04:12:22 INFO - Downloading functools32-3.2.3-2.tar.gz 04:12:22 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 04:12:22 INFO - warning: no files found matching '*.txt' 04:12:22 INFO - no previously-included directories found matching 'build' 04:12:22 INFO - no previously-included directories found matching 'dist' 04:12:22 INFO - no previously-included directories found matching '.git*' 04:12:22 INFO - Installing collected packages: jsonschema, functools32 04:12:22 INFO - Running setup.py install for functools32 04:12:22 INFO - warning: no files found matching '*.txt' 04:12:22 INFO - no previously-included directories found matching 'build' 04:12:22 INFO - no previously-included directories found matching 'dist' 04:12:22 INFO - no previously-included directories found matching '.git*' 04:12:22 INFO - Successfully installed jsonschema functools32 04:12:22 INFO - Cleaning up... 04:12:22 INFO - Return code: 0 04:12:22 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 04:12:22 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')]} 04:12:22 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:12:22 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')]} 04:12:22 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:12:22 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 0xf591f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1125a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x12c8fa0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x12cc2a0>, '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 0x12cd2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x12c74d0>, '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': '3836458cccd887f2d2de3cf1000001de-1499671981.326684-287146855', '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 04:12:22 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 04:12:22 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 04:12:22 INFO - Using env: {'DISPLAY': ':0', 04:12:22 INFO - 'HOME': '/home/cltbld', 04:12:22 INFO - 'LANG': 'en_US.UTF-8', 04:12:22 INFO - 'LANGUAGE': 'en_US:en', 04:12:22 INFO - 'LOGNAME': 'cltbld', 04:12:22 INFO - 'MAIL': '/var/mail/cltbld', 04:12:22 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:12:22 INFO - 'MOZ_NO_REMOTE': '1', 04:12:22 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:12:22 INFO - 'NO_EM_RESTART': '1', 04:12:22 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:12:22 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:12:22 INFO - 'PWD': '/builds/slave/test', 04:12:22 INFO - 'SHELL': '/bin/bash', 04:12:22 INFO - 'SHLVL': '1', 04:12:22 INFO - 'TERM': 'linux', 04:12:22 INFO - 'TMOUT': '86400', 04:12:22 INFO - 'USER': 'cltbld', 04:12:22 INFO - 'XDG_SESSION_COOKIE': '3836458cccd887f2d2de3cf1000001de-1499671981.326684-287146855', 04:12:22 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:12:22 INFO - '_': '/tools/buildbot/bin/python'} 04:12:22 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:12:22 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 04:12:22 INFO - Cleaning up... 04:12:22 INFO - Return code: 0 04:12:22 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 04:12:22 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')]} 04:12:22 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:12:22 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')]} 04:12:22 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:12:22 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 0xf591f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1125a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x12c8fa0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x12cc2a0>, '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 0x12cd2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x12c74d0>, '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': '3836458cccd887f2d2de3cf1000001de-1499671981.326684-287146855', '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 04:12:22 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 04:12:22 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 04:12:22 INFO - Using env: {'DISPLAY': ':0', 04:12:22 INFO - 'HOME': '/home/cltbld', 04:12:22 INFO - 'LANG': 'en_US.UTF-8', 04:12:22 INFO - 'LANGUAGE': 'en_US:en', 04:12:22 INFO - 'LOGNAME': 'cltbld', 04:12:22 INFO - 'MAIL': '/var/mail/cltbld', 04:12:22 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:12:22 INFO - 'MOZ_NO_REMOTE': '1', 04:12:22 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:12:22 INFO - 'NO_EM_RESTART': '1', 04:12:22 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:12:22 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:12:22 INFO - 'PWD': '/builds/slave/test', 04:12:22 INFO - 'SHELL': '/bin/bash', 04:12:22 INFO - 'SHLVL': '1', 04:12:22 INFO - 'TERM': 'linux', 04:12:22 INFO - 'TMOUT': '86400', 04:12:22 INFO - 'USER': 'cltbld', 04:12:22 INFO - 'XDG_SESSION_COOKIE': '3836458cccd887f2d2de3cf1000001de-1499671981.326684-287146855', 04:12:22 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:12:22 INFO - '_': '/tools/buildbot/bin/python'} 04:12:23 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:12:23 INFO - Downloading/unpacking blobuploader==1.2.4 04:12:23 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 04:12:23 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 04:12:23 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 04:12:23 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 04:12:24 INFO - Downloading blobuploader-1.2.4.tar.gz 04:12:24 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 04:12:24 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 04:12:24 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 04:12:24 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 04:12:24 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 04:12:24 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 04:12:24 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 04:12:24 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 04:12:24 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 04:12:24 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 04:12:24 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 04:12:24 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 04:12:24 INFO - Downloading docopt-0.6.1.tar.gz 04:12:24 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 04:12:24 INFO - Installing collected packages: blobuploader, requests, docopt 04:12:24 INFO - Running setup.py install for blobuploader 04:12:24 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 04:12:24 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 04:12:24 INFO - Running setup.py install for requests 04:12:25 INFO - Running setup.py install for docopt 04:12:25 INFO - Successfully installed blobuploader requests docopt 04:12:25 INFO - Cleaning up... 04:12:25 INFO - Return code: 0 04:12:25 INFO - Installing None into virtualenv /builds/slave/test/build/venv 04:12:25 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')]} 04:12:25 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:12:25 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')]} 04:12:25 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:12:25 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 0xf591f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1125a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x12c8fa0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x12cc2a0>, '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 0x12cd2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x12c74d0>, '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': '3836458cccd887f2d2de3cf1000001de-1499671981.326684-287146855', '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 04:12:25 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 04:12:25 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 04:12:25 INFO - Using env: {'DISPLAY': ':0', 04:12:25 INFO - 'HOME': '/home/cltbld', 04:12:25 INFO - 'LANG': 'en_US.UTF-8', 04:12:25 INFO - 'LANGUAGE': 'en_US:en', 04:12:25 INFO - 'LOGNAME': 'cltbld', 04:12:25 INFO - 'MAIL': '/var/mail/cltbld', 04:12:25 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:12:25 INFO - 'MOZ_NO_REMOTE': '1', 04:12:25 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:12:25 INFO - 'NO_EM_RESTART': '1', 04:12:25 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:12:25 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:12:25 INFO - 'PWD': '/builds/slave/test', 04:12:25 INFO - 'SHELL': '/bin/bash', 04:12:25 INFO - 'SHLVL': '1', 04:12:25 INFO - 'TERM': 'linux', 04:12:25 INFO - 'TMOUT': '86400', 04:12:25 INFO - 'USER': 'cltbld', 04:12:25 INFO - 'XDG_SESSION_COOKIE': '3836458cccd887f2d2de3cf1000001de-1499671981.326684-287146855', 04:12:25 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:12:25 INFO - '_': '/tools/buildbot/bin/python'} 04:12:25 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:12:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 04:12:25 INFO - Running setup.py (path:/tmp/pip-duco5c-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 04:12:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 04:12:25 INFO - Running setup.py (path:/tmp/pip-BsN14K-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 04:12:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 04:12:25 INFO - Running setup.py (path:/tmp/pip-IoKgeR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 04:12:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 04:12:25 INFO - Running setup.py (path:/tmp/pip-NVT95i-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 04:12:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 04:12:25 INFO - Running setup.py (path:/tmp/pip-LzwN5x-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 04:12:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 04:12:25 INFO - Running setup.py (path:/tmp/pip-YdnwtO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 04:12:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 04:12:25 INFO - Running setup.py (path:/tmp/pip-_KCiFy-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 04:12:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 04:12:26 INFO - Running setup.py (path:/tmp/pip-ilhU0z-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 04:12:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 04:12:26 INFO - Running setup.py (path:/tmp/pip-EN6bwI-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 04:12:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 04:12:26 INFO - Running setup.py (path:/tmp/pip-DyQPKr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 04:12:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 04:12:26 INFO - Running setup.py (path:/tmp/pip-Wo3mmI-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 04:12:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 04:12:26 INFO - Running setup.py (path:/tmp/pip-s7t8yr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 04:12:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 04:12:26 INFO - Running setup.py (path:/tmp/pip-6vJo26-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 04:12:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 04:12:26 INFO - Running setup.py (path:/tmp/pip-QFfc3I-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 04:12:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 04:12:26 INFO - Running setup.py (path:/tmp/pip-4HLJnr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 04:12:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 04:12:26 INFO - Running setup.py (path:/tmp/pip-lXjaL6-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 04:12:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 04:12:26 INFO - Running setup.py (path:/tmp/pip-KPOL8Q-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 04:12:26 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 04:12:26 INFO - Running setup.py install for manifestparser 04:12:26 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 04:12:26 INFO - Running setup.py install for mozcrash 04:12:26 INFO - Running setup.py install for mozdebug 04:12:27 INFO - Running setup.py install for mozdevice 04:12:27 INFO - Installing dm script to /builds/slave/test/build/venv/bin 04:12:27 INFO - Running setup.py install for mozfile 04:12:27 INFO - Running setup.py install for mozhttpd 04:12:27 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 04:12:27 INFO - Running setup.py install for mozinfo 04:12:27 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 04:12:27 INFO - Running setup.py install for mozInstall 04:12:27 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 04:12:27 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 04:12:27 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 04:12:27 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 04:12:27 INFO - Running setup.py install for mozleak 04:12:27 INFO - Running setup.py install for mozlog 04:12:27 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 04:12:27 INFO - Running setup.py install for moznetwork 04:12:27 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 04:12:27 INFO - Running setup.py install for mozprocess 04:12:27 INFO - Running setup.py install for mozprofile 04:12:28 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 04:12:28 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 04:12:28 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 04:12:28 INFO - Running setup.py install for mozrunner 04:12:28 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 04:12:28 INFO - Running setup.py install for mozscreenshot 04:12:28 INFO - Running setup.py install for moztest 04:12:28 INFO - Running setup.py install for mozversion 04:12:28 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 04:12:28 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 04:12:28 INFO - Cleaning up... 04:12:28 INFO - Return code: 0 04:12:28 INFO - Installing None into virtualenv /builds/slave/test/build/venv 04:12:28 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')]} 04:12:28 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:12:28 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')]} 04:12:28 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:12:28 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 0xf591f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1125a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x12c8fa0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x12cc2a0>, '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 0x12cd2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x12c74d0>, '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': '3836458cccd887f2d2de3cf1000001de-1499671981.326684-287146855', '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 04:12:28 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 04:12:28 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 04:12:28 INFO - Using env: {'DISPLAY': ':0', 04:12:28 INFO - 'HOME': '/home/cltbld', 04:12:28 INFO - 'LANG': 'en_US.UTF-8', 04:12:28 INFO - 'LANGUAGE': 'en_US:en', 04:12:28 INFO - 'LOGNAME': 'cltbld', 04:12:28 INFO - 'MAIL': '/var/mail/cltbld', 04:12:28 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:12:28 INFO - 'MOZ_NO_REMOTE': '1', 04:12:28 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:12:28 INFO - 'NO_EM_RESTART': '1', 04:12:28 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:12:28 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:12:28 INFO - 'PWD': '/builds/slave/test', 04:12:28 INFO - 'SHELL': '/bin/bash', 04:12:28 INFO - 'SHLVL': '1', 04:12:28 INFO - 'TERM': 'linux', 04:12:28 INFO - 'TMOUT': '86400', 04:12:28 INFO - 'USER': 'cltbld', 04:12:28 INFO - 'XDG_SESSION_COOKIE': '3836458cccd887f2d2de3cf1000001de-1499671981.326684-287146855', 04:12:28 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:12:28 INFO - '_': '/tools/buildbot/bin/python'} 04:12:28 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:12:28 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 04:12:28 INFO - Running setup.py (path:/tmp/pip-fVHuF1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 04:12:28 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)) 04:12:28 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 04:12:28 INFO - Running setup.py (path:/tmp/pip-3TGd0y-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 04:12:28 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)) 04:12:28 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 04:12:28 INFO - Running setup.py (path:/tmp/pip-Mmwpdx-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 04:12:28 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)) 04:12:28 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 04:12:28 INFO - Running setup.py (path:/tmp/pip-klBPAU-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 04:12:29 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)) 04:12:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 04:12:29 INFO - Running setup.py (path:/tmp/pip-4UDd9z-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 04:12:29 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)) 04:12:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 04:12:29 INFO - Running setup.py (path:/tmp/pip-PWGs80-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 04:12:29 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)) 04:12:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 04:12:29 INFO - Running setup.py (path:/tmp/pip-4WhwVp-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 04:12:29 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)) 04:12:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 04:12:29 INFO - Running setup.py (path:/tmp/pip-PCCeRf-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 04:12:29 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)) 04:12:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 04:12:29 INFO - Running setup.py (path:/tmp/pip-HN_33Y-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 04:12:29 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)) 04:12:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 04:12:29 INFO - Running setup.py (path:/tmp/pip-AsXc01-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 04:12:29 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)) 04:12:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 04:12:29 INFO - Running setup.py (path:/tmp/pip-j_0dSk-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 04:12:29 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)) 04:12:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 04:12:29 INFO - Running setup.py (path:/tmp/pip-zQDfPt-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 04:12:29 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)) 04:12:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 04:12:29 INFO - Running setup.py (path:/tmp/pip-Mj2Jqq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 04:12:29 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)) 04:12:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 04:12:29 INFO - Running setup.py (path:/tmp/pip-k6A0de-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 04:12:29 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)) 04:12:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 04:12:29 INFO - Running setup.py (path:/tmp/pip-ufjsaj-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 04:12:29 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)) 04:12:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 04:12:29 INFO - Running setup.py (path:/tmp/pip-APEoAx-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 04:12:29 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)) 04:12:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 04:12:29 INFO - Running setup.py (path:/tmp/pip-w81rZW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 04:12:30 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)) 04:12:30 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)) 04:12:30 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)) 04:12:30 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)) 04:12:30 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)) 04:12:30 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)) 04:12:30 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)) 04:12:30 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.5->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 04:12:30 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 04:12:30 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 04:12:30 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 04:12:30 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 04:12:31 INFO - Downloading blessings-1.6.tar.gz 04:12:31 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 04:12:31 INFO - Installing collected packages: blessings 04:12:31 INFO - Running setup.py install for blessings 04:12:31 INFO - Successfully installed blessings 04:12:31 INFO - Cleaning up... 04:12:31 INFO - Return code: 0 04:12:31 INFO - Done creating virtualenv /builds/slave/test/build/venv. 04:12:31 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 04:12:31 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 04:12:31 INFO - Reading from file tmpfile_stdout 04:12:31 INFO - Current package versions: 04:12:31 INFO - argparse == 1.2.1 04:12:31 INFO - blessings == 1.6 04:12:31 INFO - blobuploader == 1.2.4 04:12:31 INFO - docopt == 0.6.1 04:12:31 INFO - functools32 == 3.2.3-2 04:12:31 INFO - jsonschema == 2.5.1 04:12:31 INFO - manifestparser == 1.1 04:12:31 INFO - mozInstall == 1.13 04:12:31 INFO - mozcrash == 1.0 04:12:31 INFO - mozdebug == 0.1 04:12:31 INFO - mozdevice == 0.51 04:12:31 INFO - mozfile == 1.2 04:12:31 INFO - mozhttpd == 0.7 04:12:31 INFO - mozinfo == 0.10 04:12:31 INFO - mozleak == 0.1 04:12:31 INFO - mozlog == 3.5 04:12:31 INFO - moznetwork == 0.27 04:12:31 INFO - mozprocess == 0.25 04:12:31 INFO - mozprofile == 0.28 04:12:31 INFO - mozrunner == 6.13 04:12:31 INFO - mozscreenshot == 0.1 04:12:31 INFO - mozsystemmonitor == 0.3 04:12:31 INFO - moztest == 0.8 04:12:31 INFO - mozversion == 1.4 04:12:31 INFO - psutil == 3.1.1 04:12:31 INFO - requests == 1.2.3 04:12:31 INFO - wsgiref == 0.1.2 04:12:31 INFO - Installing None into virtualenv /builds/slave/test/build/venv 04:12: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')]} 04:12:31 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:12: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')]} 04:12:31 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:12:31 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 0xf591f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1125a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x12c8fa0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x12cc2a0>, '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 0x12cd2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x12c74d0>, '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': '3836458cccd887f2d2de3cf1000001de-1499671981.326684-287146855', '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 04:12:31 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 04:12:31 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 04:12:31 INFO - Using env: {'DISPLAY': ':0', 04:12:31 INFO - 'HOME': '/home/cltbld', 04:12:31 INFO - 'LANG': 'en_US.UTF-8', 04:12:31 INFO - 'LANGUAGE': 'en_US:en', 04:12:31 INFO - 'LOGNAME': 'cltbld', 04:12:31 INFO - 'MAIL': '/var/mail/cltbld', 04:12:31 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:12:31 INFO - 'MOZ_NO_REMOTE': '1', 04:12:31 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:12:31 INFO - 'NO_EM_RESTART': '1', 04:12:31 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:12:31 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:12:31 INFO - 'PWD': '/builds/slave/test', 04:12:31 INFO - 'SHELL': '/bin/bash', 04:12:31 INFO - 'SHLVL': '1', 04:12:31 INFO - 'TERM': 'linux', 04:12:31 INFO - 'TMOUT': '86400', 04:12:31 INFO - 'USER': 'cltbld', 04:12:31 INFO - 'XDG_SESSION_COOKIE': '3836458cccd887f2d2de3cf1000001de-1499671981.326684-287146855', 04:12:31 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:12:31 INFO - '_': '/tools/buildbot/bin/python'} 04:12:31 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:12:31 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)) 04:12:31 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)) 04:12:31 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)) 04:12:31 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)) 04:12:31 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)) 04:12:31 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)) 04:12:31 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)) 04:12:31 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)) 04:12:31 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)) 04:12:31 INFO - Downloading/unpacking marionette-driver>=1.4.0 (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 10)) 04:12:31 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 04:12:31 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 04:12:31 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 04:12:31 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 04:12:32 INFO - Downloading marionette_driver-1.4.0.tar.gz 04:12:32 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/marionette-driver/setup.py) egg_info for package marionette-driver 04:12:32 INFO - Downloading/unpacking simplejson>=2.1.1 (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 11)) 04:12:32 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 04:12:32 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 04:12:32 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 04:12:32 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 04:12:33 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/simplejson/setup.py) egg_info for package simplejson 04:12:33 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)) 04:12:33 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)) 04:12:33 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)) 04:12:33 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)) 04:12:33 INFO - Installing collected packages: marionette-driver, simplejson 04:12:33 INFO - Running setup.py install for marionette-driver 04:12:33 INFO - Running setup.py install for simplejson 04:12:33 INFO - building 'simplejson._speedups' extension 04:12:33 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 04:12:34 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 04:12:34 INFO - Successfully installed marionette-driver simplejson 04:12:34 INFO - Cleaning up... 04:12:34 INFO - Return code: 0 04:12:34 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 04:12:34 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')]} 04:12:34 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:12:34 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')]} 04:12:34 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:12:34 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 0xf591f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1125a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x12c8fa0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x12cc2a0>, '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 0x12cd2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x12c74d0>, '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': '3836458cccd887f2d2de3cf1000001de-1499671981.326684-287146855', '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 04:12:34 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 04:12:34 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 04:12:34 INFO - Using env: {'DISPLAY': ':0', 04:12:34 INFO - 'HOME': '/home/cltbld', 04:12:34 INFO - 'LANG': 'en_US.UTF-8', 04:12:34 INFO - 'LANGUAGE': 'en_US:en', 04:12:34 INFO - 'LOGNAME': 'cltbld', 04:12:34 INFO - 'MAIL': '/var/mail/cltbld', 04:12:34 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:12:34 INFO - 'MOZ_NO_REMOTE': '1', 04:12:34 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:12:34 INFO - 'NO_EM_RESTART': '1', 04:12:34 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:12:34 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:12:34 INFO - 'PWD': '/builds/slave/test', 04:12:34 INFO - 'SHELL': '/bin/bash', 04:12:34 INFO - 'SHLVL': '1', 04:12:34 INFO - 'TERM': 'linux', 04:12:34 INFO - 'TMOUT': '86400', 04:12:34 INFO - 'USER': 'cltbld', 04:12:34 INFO - 'XDG_SESSION_COOKIE': '3836458cccd887f2d2de3cf1000001de-1499671981.326684-287146855', 04:12:34 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:12:34 INFO - '_': '/tools/buildbot/bin/python'} 04:12:34 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:12:34 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 04:12:34 INFO - Cleaning up... 04:12:34 INFO - Return code: 0 04:12:34 INFO - Running post-action listener: _resource_record_post_action 04:12:34 INFO - Running post-action listener: _start_resource_monitoring 04:12:34 INFO - Starting resource monitoring. 04:12:34 INFO - [mozharness: 2017-07-10 11:12:34.610753Z] Finished create-virtualenv step (success) 04:12:34 INFO - [mozharness: 2017-07-10 11:12:34.611223Z] Running install step. 04:12:34 INFO - Running pre-action listener: _resource_record_pre_action 04:12:34 INFO - Running main action method: install 04:12:34 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 04:12:34 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 04:12:34 INFO - Reading from file tmpfile_stdout 04:12:34 INFO - Detecting whether we're running mozinstall >=1.0... 04:12:34 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 04:12:34 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 04:12:34 INFO - Reading from file tmpfile_stdout 04:12:34 INFO - Output received: 04:12:34 INFO - Usage: mozinstall [options] installer 04:12:34 INFO - Options: 04:12:34 INFO - -h, --help show this help message and exit 04:12:34 INFO - -d DEST, --destination=DEST 04:12:34 INFO - Directory to install application into. [default: 04:12:34 INFO - "/builds/slave/test"] 04:12:34 INFO - --app=APP Application being installed. [default: firefox] 04:12:34 INFO - mkdir: /builds/slave/test/build/application 04:12:34 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'] 04:12:34 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/target.tar.bz2 --destination /builds/slave/test/build/application 04:12:53 INFO - Reading from file tmpfile_stdout 04:12:53 INFO - Output received: 04:12:53 INFO - /builds/slave/test/build/application/firefox/firefox 04:12:53 INFO - Running post-action listener: _resource_record_post_action 04:12:53 INFO - [mozharness: 2017-07-10 11:12:53.021187Z] Finished install step (success) 04:12:53 INFO - [mozharness: 2017-07-10 11:12:53.021493Z] Running setup-mitmproxy step. 04:12:53 INFO - Running pre-action listener: _resource_record_pre_action 04:12:53 INFO - Running main action method: setup_mitmproxy 04:12:53 INFO - Skipping: mitmproxy is not required 04:12:53 INFO - Running post-action listener: _resource_record_post_action 04:12:53 INFO - [mozharness: 2017-07-10 11:12:53.022628Z] Finished setup-mitmproxy step (success) 04:12:53 INFO - [mozharness: 2017-07-10 11:12:53.022865Z] Running run-tests step. 04:12:53 INFO - Running pre-action listener: _resource_record_pre_action 04:12:53 INFO - Running pre-action listener: _set_gcov_prefix 04:12:53 INFO - Running main action method: run_tests 04:12:53 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 04:12:53 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 04:12:53 INFO - Python 2.7.3 04:12:53 INFO - Return code: 0 04:12:53 INFO - grabbing minidump binary from tooltool 04:12:53 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')]} 04:12:53 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 0x12cc2a0>, '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 0x12cd2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x12c74d0>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 04:12:53 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 04:12:53 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 04:12:53 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 04:12:53 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 04:12:53 INFO - Return code: 0 04:12:53 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 04:12:53 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 04:12:53 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 04:12:53 INFO - ENV: RUST_BACKTRACE is now 1 04:12:53 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 04:12:53 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 04:12:53 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/aA7Yn3CFSGWrt0-fZEf0Jw/artifacts/public/build/target.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-030', '--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 04:12:53 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/aA7Yn3CFSGWrt0-fZEf0Jw/artifacts/public/build/target.crashreporter-symbols.zip --title talos-linux64-ix-030 --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 04:12:53 INFO - Using env: {'DISPLAY': ':0', 04:12:53 INFO - 'HOME': '/home/cltbld', 04:12:53 INFO - 'LANG': 'en_US.UTF-8', 04:12:53 INFO - 'LANGUAGE': 'en_US:en', 04:12:53 INFO - 'LOGNAME': 'cltbld', 04:12:53 INFO - 'MAIL': '/var/mail/cltbld', 04:12:53 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 04:12:53 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 04:12:53 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:12:53 INFO - 'MOZ_NO_REMOTE': '1', 04:12:53 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 04:12:53 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:12:53 INFO - 'NO_EM_RESTART': '1', 04:12:53 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:12:53 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:12:53 INFO - 'PWD': '/builds/slave/test', 04:12:53 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 04:12:53 INFO - 'RUST_BACKTRACE': '1', 04:12:53 INFO - 'SCRIPTSPATH': '/builds/slave/test/scripts', 04:12:53 INFO - 'SHELL': '/bin/bash', 04:12:53 INFO - 'SHLVL': '1', 04:12:53 INFO - 'TERM': 'linux', 04:12:53 INFO - 'TMOUT': '86400', 04:12:53 INFO - 'USER': 'cltbld', 04:12:53 INFO - 'XDG_SESSION_COOKIE': '3836458cccd887f2d2de3cf1000001de-1499671981.326684-287146855', 04:12:53 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:12:53 INFO - '_': '/tools/buildbot/bin/python'} 04:12:53 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/aA7Yn3CFSGWrt0-fZEf0Jw/artifacts/public/build/target.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-030', '--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 04:12:53 INFO - mozversion application_buildid: 20170710102351 04:12:53 INFO - mozversion application_changeset: bd802b54879e64c786754b9931c2a3a505119da9 04:12:53 INFO - mozversion application_display_name: Nightly 04:12:53 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 04:12:53 INFO - mozversion application_name: Firefox 04:12:53 INFO - mozversion application_remotingname: firefox 04:12:53 INFO - mozversion application_repository: https://hg.mozilla.org/mozilla-central 04:12:53 INFO - mozversion application_vendor: Mozilla 04:12:53 INFO - mozversion application_version: 56.0a1 04:12:53 INFO - mozversion platform_buildid: 20170710102351 04:12:53 INFO - mozversion platform_changeset: bd802b54879e64c786754b9931c2a3a505119da9 04:12:53 INFO - mozversion platform_repository: https://hg.mozilla.org/mozilla-central 04:12:53 INFO - mozversion platform_version: 56.0a1 04:12:53 INFO - using testdate: 1499685173 04:12:53 INFO - actual date: 1499685173 04:12:53 INFO - starting webserver on 'localhost:50872' 04:12:53 INFO - SUITE-START | Running 2 tests 04:12:53 INFO - TEST-START | dromaeo_css 04:12:53 INFO - Initialising browser for dromaeo_css test... 04:12:53 INFO - Application command: /builds/slave/test/build/application/firefox/firefox http://localhost:50872/getInfo.html -profile /tmp/tmpKmOcQE/profile 04:12:53 INFO - TEST-INFO | started process 11044 (/builds/slave/test/build/application/firefox/firefox http://localhost:50872/getInfo.html) 04:12:59 INFO - TEST-INFO | 11044: exit 0 04:12:59 INFO - Browser initialized. 04:12:59 INFO - Running cycle 1/1 for dromaeo_css test... 04:12:59 INFO - TEST-INFO | started process 11269 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpKmOcQE/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpnoisy -tpcycles 1 -tppagecycles 1) 04:13:11 INFO - PID 11269 | RSS: Main: 173572096 04:13:11 INFO - PID 11269 | 04:16:12 INFO - PID 11269 | Cycle 1(1): loaded http://localhost:50872/tests/dromaeo/cssquery-dojo.html (next: http://localhost:50872/tests/dromaeo/cssquery-ext.html) 04:16:13 INFO - PID 11269 | RSS: Main: 180523008 04:16:13 INFO - PID 11269 | 04:19:15 INFO - PID 11269 | Cycle 1(1): loaded http://localhost:50872/tests/dromaeo/cssquery-ext.html (next: http://localhost:50872/tests/dromaeo/cssquery-jquery.html) 04:19:16 INFO - PID 11269 | RSS: Main: 177549312 04:19:16 INFO - PID 11269 | 04:22:17 INFO - PID 11269 | Cycle 1(1): loaded http://localhost:50872/tests/dromaeo/cssquery-jquery.html (next: http://localhost:50872/tests/dromaeo/cssquery-mootools.html) 04:22:18 INFO - PID 11269 | RSS: Main: 178593792 04:22:18 INFO - PID 11269 | 04:25:20 INFO - PID 11269 | Cycle 1(1): loaded http://localhost:50872/tests/dromaeo/cssquery-mootools.html (next: http://localhost:50872/tests/dromaeo/cssquery-prototype.html) 04:25:20 INFO - PID 11269 | RSS: Main: 179412992 04:25:20 INFO - PID 11269 | 04:28:23 INFO - PID 11269 | Cycle 1(1): loaded http://localhost:50872/tests/dromaeo/cssquery-prototype.html (next: http://localhost:50872/tests/dromaeo/cssquery-yui.html) 04:28:24 INFO - PID 11269 | RSS: Main: 178229248 04:28:24 INFO - PID 11269 | 04:31:26 INFO - PID 11269 | Cycle 1(1): loaded http://localhost:50872/tests/dromaeo/cssquery-yui.html (next: http://localhost:50872/tests/dromaeo/cssquery-dojo.html) 04:31:26 INFO - PID 11269 | RSS: Main: 181878784 04:31:26 INFO - PID 11269 | 04:31:26 INFO - PID 11269 | __start_tp_report 04:31:26 INFO - PID 11269 | _x_x_mozilla_page_load 04:31:26 INFO - PID 11269 | _x_x_mozilla_page_load_details 04:31:26 INFO - PID 11269 | |i|pagename|runs| 04:31:26 INFO - PID 11269 | |0;dojo.html;3054.419660264551;3123.7813353065285;3128.1866714654197;3145.4023735490255;3161.9367612647757;5993.640381577103;6004.219451471308;6016.067509536029;6029.939700602988;6104.5116390688745;6045.33501314855;6076.179715738374;6084.574079814403;6114.938850611493;6115.235595550556;5504.944950550484;5548.001359755252;5555.444455554452;5571.247881536002;5590.133529302964;5576.832695019156;5590.161475778625;5592.86017849553;5598.860028499279;5618.269624948751;5578.8605284868;5581.7209139543065;5583.218349431063;5588.91616625751;5610.298712660918;5542.8337149885565;5544.16837474378;5553.861153471175;5563.388027316992;5567.415421380778;5493.093639549509;5522.392536820947;5572.7770889164385;5634.774609015634;5725.828225153252;6116.113163591299;6123.234595675541;6130.4176103270565;6235.314115447297;6235.501159907197;6232.158658581124;6350.396712312323;6546.574472659262;6645.169353830771;6646.401823835878;6510.381513756186;6517.804465865985;6538.150040494753;6543.116679248288;6548.083268342436;6026.578139530191;6027.939720602782;6052.122442245894;6070.271567411939;6072.301685306202;6596.340365963365;6622.940329547249;6638.86722265552;6680.498962577826;6685.866282674319;6340.365963403715;6434.131392262078;6441.25925518562;6499.927511960474;6528.934710652928;6542.411182993554;6545.247296560861;6622.139121914121;6632.734690612321;6663.500237482208;6219.875602487925;6251.3123556408755;6310.9368906311265;6316.715747791361;6517.120188774455;6413.583117097373;6494.870102598016;6528.836779080466;6543.149390579194;6602.73589056442;5239.292695486137;5292.259083728204;5338.46615338463;5399.406065332811;5421.674699518042;4525.7510836904285;4558.88602784933;4571.245744452194;4593.173228818845;4596.195665758479;5627.690477023803;5640.971795140998;5655.1799989001365;5673.659580425187;5675.574331925122;6498.317676643885;6500.902486462707;6522.34776522344;6541.443977261891;6549.869002619921;5668.57485688575;5674.574406919415;5710.057840456361;5791.884162316815;5800.8259752207505;5731.684757338387;5775.27809023872;5818.010938140442;5822.068469045017;5824.767009319579;6296.275928268216;6328.145700330489;6331.525135614847;6341.175647165839;6384.553081284265;6480.287168411565;6499.935000649933;6553.803385898431;6561.376669216417;6570;6340.841478963062;6352.047192920914;6359.427651511386;6389;6479.449246814073;6386.552941294065;6447.580907241015;6452.161219041494;6547.345265473415;6549.967250163719;6520.282768895512;6599.8020059398295;6604.306547812603;6628.867422651423;6673.666316684244;6111.786087486917;6222.657753823583;6225.719842607003;6236.688165591793;6456.386643268882;6308.747650093945;6336.112944187726;6353.777617783356;6355.110284560073;6366.076918846834;5080.173265445697;6218.595791273553;6260.998240281533;6263.592866463665;6301.6219026858535;6406.327335629878;6416.7754128605275;6434.324395938546;6502.089707441057;6542.705578248895;6172.845678858064;6175.814725558241;6235.532335074797;6284.74861005573;6292.4966002720585 04:31:26 INFO - PID 11269 | |1;ext.html;787.6888628991549;813.4875028731898;841.1966571923812;874.6763697431951;874.9912500874991;40782;41945;42052.158956820844;42251.78874105633;42286;39057.60942390575;39177.80411097948;39255.607443925626;39271.41092883609;39291.41062884059;6864.828379290508;6980.790576282694;6986.126734158231;6998.545094568837;7005.754798582051;6928.44572434204;6942.444604431658;6978.511504194708;7017.157941047081;7020.122484689414;6955.826104347381;6973.546719463244;7024.4029257513175;7033.085698859141;7038.85922281554;6902.654867256617;6937.861242775141;6946.79159625212;6963.930360696404;7000.5099643025005;6209.316975132731;6231.6572588507615;6245.188125543696;6251.437370636664;6262.091996660459;33286.50070248948;33752;33867;33888.66111338904;33930.83034584836;3429.657034296575;3431.9313613727836;3481.3559491494157;3503.9474407883904;3670.5228320318456;31181.688183118105;31391.37217255665;31523.684763152305;31566.684333156605;31691.84154079238;4682.461516925563;4897.240927656183;4915.729634870081;5001.4998500149695;5081.66969147008;183828;183933;186402.06798966054;196025;197325;43164.13671726548;48598.75700621474;49150;49183.75408122937;49698;51547.96904061898;51556.484435155166;51699;51731.741341293804;51808.74095629573;16115;16173.676526469404;16211.594710132105;16229.431969881234;16236;13477.258750768802;13566.050376473551;13569.118007329493;13634.318284085755;13656.726865462635;14039.859601403856;14139.717205655828;14142.43430262778;14173;14314.355853986595;5478.945210547923;5601;5609.214709940612;5613.747381367848;5742.942570574324;990.8761404824397;1008.7578981044643;1013.690824298596;1041.1670663469195;1041.8958104189521;22904.65643015356;22911.427214319774;23049.769502304764;23607.763922360555;23859.64210536843;1080.6541906589973;1096.4079397125463;1119.8656161260537;1134.7560274541013;1149.735560821016;12383.814242786366;12492.375381230902;12580.182288151424;12610;12654.557090501788;233678;234195;234368;234561;235137;53288.20067698987;54244.64388390243;54256.186157207674;54558;54659.45340546623;1415.6248594122567;1486.7695507196402;1489.0098084773722;1494.5889880282791;1502.1212590634382;22882.771172288063;23038.193663222377;23304.650430243222;23497.41256468602;23604.411610656658;38711.2257754849;38909;38949.415758763076;39045.8047709771;39121.217575648894;194803;195432;195921;197609;197937;34570;36018.8199059003;36405.27189456249;38477.80761096177;38748;45875.082498350515;47442.28836567523;47582;48089.75955120202;48303.75848120737;31742.206444839063;33352.40473833219;34074.659253407146;34121.146971325914;34354.656453436146;33291;33398.16504587405;34181.65818341785;34453.310933781686;34896.82551587226;37643.81178094092;37887.43168852525;38116.428253575665;38161;38224;31047.223819403793;32496.83751581227;33300;33605.495917560766;33880.49179262264;23424.765752342257;24349;24874.626880597167;24930.87534562388;25011.499770004135 04:31:26 INFO - PID 11269 | |2;jquery.html;558.2157069317608;563.9323281206256;573.6318879472457;589.3752622220445;598.2282855116898;21820.563588728237;22853.542929141408;22874.88562557189;22911.42721431965;22934.65598016031;23981.76018239817;26414.867925660394;26541.336466588346;26640.200793976164;26727.06455274061;6529.15121034266;6679.499037572177;6681.432078273353;6704.832379190535;6722.327767223263;6575.868482630344;6620.437262832641;6652.93347066528;6696.096027036337;6728;6157.168782214411;6310.684465776716;6417.7112029958535;6483.7082331295205;6636.966815165917;6441.420272175504;6465.418112369909;6491.253505846841;6510.772122975721;6529.967350163242;6042.939570604326;6043.758249670008;6050.425209605124;6059.757609695607;6065.727042283108;26640.73359266402;28270.293242668893;28602.14193574196;28704;28754.568681469795;1950.3856285270094;1995.760508738946;2009.9196032158695;2010.1858747207405;2016.8184863362367;18066.458006259832;18663.906680466647;18685.06574671261;18687.43937681872;18697.719534206997;2344.824138189643;2368.2184878990065;2412.372783076395;2417.0452671194957;2435.0990133650484;124465;125623;127909.36045319714;128229;129061.99999999905;13539.729205415837;13795.517156899461;14279.57161285163;14763.852361476462;14933.626659333604;23166;23248.53502929932;23313.533729325656;23345.41636459102;23375.181868634518;9778.65774697882;10028.749281267881;10059.5473203706;10064;10120.59517619287;9188.40275382098;9325.953370233105;9417.717468475958;9420.434773913586;9471.810563788686;8900.42147260426;8909.821803563893;8945.642174312954;9085.863712044325;9095.681651142311;2666.4667066586762;2732.49448851963;2734.6991830898587;2739.397332586828;2748.848813315247;967.6226271754022;975.2246963663904;984.4290311619244;986.1075726467415;992.1467537917385;19303.131359088875;19542;19743;19790.901045494968;19945.800541994686;982.1013772398176;1023.6928921323573;1046.9110125639254;1054.9894501055044;1063.8882917293572;10380.97570973653;10736.516856741466;10806.405647689453;10913.181511386678;10970;507976;513335;521475;521662;539079;107629.46185269023;109538;110383.44808276067;110567;112471.43764281126;1280.6542233596876;1282.0576875996321;1316.967075823112;1319.6766792135988;1327.6879933215687;17000.74498882493;17015.319387224867;17015.744763828305;17021.40425085116;17117.315307387566;48502.757486212344;50358;50634;50996.49003510066;51021.234681479065;67971.66014169897;70135.29864701288;72585.6370718143;73446;74084.62957685177;12601.747965040831;13090.869091309345;13467.989900757679;13468.393922273326;13470.124441911245;18790.24839006479;18836.434906952814;18905.527361816065;18949.621007580048;19028.429147125054;16003.279852406902;16140;16163.353465861233;16176.110313932846;16243.51269461918;13901;13907.58277251684;14240.145591264558;14753.92623036878;15279.847201527842;16479.670406592042;16588.253528591486;16633.750493742362;16644.50066498007;16651.16744162763;13148.211107333591;13253.867461325262;13326.9333653335;13418.194908305533;13464.259465729087;14954.327055282756;15003.324850381978;15175;15187.164705940837;15214.467493637669 04:31:26 INFO - PID 11269 | |3;mootools.html;1345.2937207965817;1389.7081612861298;1397.4899161805945;1399.930003499826;1407.725493528762;13247.470101195953;13284.13653112547;13815.30923453827;13975.16149031059;13991;13179.73640527189;14160.787588186186;14185.503507377243;14225.430982760703;14254.572362829105;2633.723459036802;2682.745139211772;2685.932851678714;2692.67687877455;2694.730526947309;2552.8978840846435;2601.2586412872333;2607.5958226474927;2618.7643112119904;2620.109162884619;2454.472288457981;2590.2358804152727;2612.6472926154916;2638.93402664933;2647.3381654586356;2596.2341109372687;2695.5417579011614;2698.17705599792;2700.8379497230035;2704.1211606227857;2544.6183072539084;2550.5409026375246;2563.5898256279092;2574.1633968959977;2581.922542323733;13047.217166970013;13340.399682014333;13349.666258343523;13363.198208107544;13382;7311.195768465464;7624.085109786805;7624.580648064354;7643.350315223212;7646;4981.9252711209365;5036.104240061943;5056.292119103328;5120.795168193268;5182.481751824787;1758.5339884930504;1813.6010077782867;1839.0988415676222;1860.2466001269509;1882.2471011595335;22084.33746987593;22174.445638859157;22234.444138896655;22252.777472225232;22365.552688946293;5938.109283607407;6016.578839481282;6239;6285;6293.716782744787;14982.325795339018;15203.619909502351;15208.08751474915;15255.313510891814;15295.388184472497;7035.92964070363;7170.749023784142;7192.136943566806;7199.2080871104135;7209.927900721031;6514.478841692653;6622.470202383798;6625.238097618739;6738.494612904052;6750.122484077038;4677.859664210079;4859.975700121548;4894.510548945077;4919.65562410635;5054.267131265946;1334.152812963775;1356.620146359021;1371.1293328736324;1385.7852032934709;1386.1544457880684;829.1169904052165;858.2919091749332;859.8882145321069;866.6316815353449;891.8483857744199;6914.654267286615;6924.61914594692;6971.3028697129885;6994.195667498201;7078.0444639973975;693.2997672350962;705.7953193573909;740.3558903753768;745.187745357552;746.2500187311825;4381.824727010948;4869.537393947569;4932.21084626458;5044.697318160922;5086.21163719624;17534.736978945326;17860.28558857657;18012.729809052875;18124.184411701506;18147.818521814614;17263.913680431517;17628.823711762976;17732.556686082695;17936.730949035777;17978.5505362367;10227.232957528364;10240.948795255976;10260.589576417009;10520.631777887736;10660.733481663021;7219.927800721925;7255.2019277878335;7274.854502909806;7308;7344.22885597026;14520.85479145195;15417.922910385376;15532.92233538825;15986.520404387888;16032.919835400748;16346.67306653884;16507.83492165063;16719.749203762196;16746.665066698843;16827.495175144766;9942.950285248528;9950.154236889946;9962.701118966443;10002.949985250318;10029.398236105857;12533.623991280276;12706.237625742486;12715.364231788188;12830.935845320713;12931.676708082374;10200;10413.895861041596;10442.477876106317;10747.408892510673;10800.297980631234;9519.476428796483;9553.522323883639;9909.256805739455;10095.7476063099;10430.895691043295;8860.822783544421;8950.462972221687;8986.101389861224;8999.955000224956;9005.7748556284;6771.255161932085;6913.654317284217;6957.756478523227;6987.441004719712;6995.230524642184;6183.536234782499;6186.536009799193;6248.5313601479165;6298.527610429144;6320.62076275425 04:31:26 INFO - PID 11269 | |4;prototype.html;490.8510020331104;501.1127651107606;512.8974205158968;519.9584033277338;524.0697761473386;5979.760809567612;6182.196314479117;6182.938170618292;6185.062340153458;6189.659568723719;5763.740631671574;6017.338092809799;6039.154518367421;6064.727087281072;6092.116643086761;4933.481984391641;4934.21052631579;4974.278729584208;4975.601951843862;5002.849914502553;4927.827526036589;4977.55202031817;4981.875453113665;4986;5008;4674.90650186996;4850.199717046683;4890.902181956359;4905.460399356086;4928.827491037814;4760.928586071212;4818.024609909938;4839.249916262985;4858.271259311096;4891.893647533806;4360.345948107777;4372.825086996516;4373.7813109344725;4384.145091707119;4395.560443955611;5857.150713146612;5865.765369385262;5954.75465871097;5990.400959904018;5992.43071908168;5471.398146203915;5538.972305138489;5573.27547418837;5632.549396048306;5654.123610840285;6433.774817881398;6440.645764482952;6454.32229615893;6464.547481676284;6479.35206479353;4797;4803.814264509675;4818.229083346648;4845.491223421525;4851.10254602896;6765.323467653245;6786.3892249697765;6787.16746478453;6840.555363901381;6854.794356169323;4917.58200552957;4958.157113290749;4970;4980.477049909779;4991.800327986913;4925.13810083234;4967.950320496749;4973.328600638867;5003.449620541737;5019.899602008012;5506.752196151103;5510.91733623996;5534.529564987021;5565.499105080562;5566.415526369673;6332.968335158294;6369.681515924185;6421;6428.5178611604315;6432.839179020562;1716.4249976257843;1722.9483115506555;1734.8525375342986;1736.053850651398;1742.668892910343;1097.8572785537829;1133.973753752855;1193.7910865598485;1205.6563879294358;1220.4385982448173;5473.236015811989;5606.439356064361;5629.4652008059165;5660.179274005246;5704.687921778014;6420.390062944013;6462.838429039311;6496.902546461807;6517.51118666102;6519.380658837403;5552.888942221214;5657.575681823797;5658.377578466366;5661.264035675418;5679.517241034476;3398.4052790761516;3446.603640581315;3496.3706532824335;3509;3522.330757156132;6301.842453938688;6319.905201421982;6365.458935990493;6408.198975128109;6429.1320671709655;6565.244996825426;6590.110335104795;6599.713055954139;6616.636085015371;6776.593404395752;6299.700609277672;6319.842003949938;6368.363163683594;6373.195793850691;6409.166808314889;6599.5050371223315;6618.801435956929;6628.801135965929;6657.267700553032;6658.300878407697;6408;6455.67721613908;6459.224893012869;6609.438197753053;6619.106420633153;6342.904856427065;6344.460720838781;6366.607041141598;6383.904241436289;6384.521160912857;4823.421189457287;4871.272087630938;4924.901501970012;4928.359313289249;4945.208766597327;6494.967525162344;6557.967210163919;6603.141591593062;6619.304972977768;6658.600483970978;6218.792328723238;6340.207474065742;6380.330065343072;6390.936090639034;6419;6200.348963358782;6305.8108256752375;6306.558540902093;6345.777897773556;6428.260750013621;6237.5009999200865;6275.52933529978;6277.466415354746;6284.151639528788;6351.2060992375955;6385.808425747235;6399.968000159969;6411.903821442589;6444.712127194778;6484.870302593828;5967;6115.296740874856;6209.19280493551;6243.938530449744;6282.371762823681 04:31:26 INFO - PID 11269 | |5;yui.html;874.3748220022684;910.7495438754341;928.1971095002824;934.3086116273955;937.742120916748;16191.271392787323;16226;16269.91865040676;16288.592785180377;18232.635347293046;19521.51196220095;20495.282665106723;21100;21308.36074917755;21390.57218855622;1022.6062965758199;1037.9584816607326;1042.8748550173989;1044.7179261599401;1046.2205656785704;1053.1522124689623;1053.5838343854211;1063.6596289187464;1065.7655315830505;1066.6693325069214;991.192178374626;1045.2108657963227;1095.6658219243127;1105.6351404036689;1115.314081839671;1074.6507385099835;1077.9245452818307;1078.7087486378634;1078.9784204315908;1079.6976846482996;790.324272746799;792.9881051784228;793.3573805217792;794.4041968523608;795.7214974758846;17275.740863886927;17451.5637109072;17470.737938930924;17504.299828006864;19367.612647747108;19203.903980480147;19907.701384479245;20034.1986320547;20145.395638130878;20284.863987896864;15628.374865005386;15967.281472333772;15984.360625574964;15998;16001.119938403383;3522.3483655523555;3548.095235714902;3550.627184145679;3573.356795776759;3575.1777091268896;101695;101868;105787.47106264497;105944.47027764888;106609;14956.252187390586;15148.318325675371;15181.924090379478;15351.232438378036;15495.767563486557;23234;28473.28816779597;28597.714022859505;28687.426251474855;28752.281192970342;8477.194666506672;8635.093315201939;8679.652813887375;8703.564821758886;8723.084076172037;3949.624785645359;4074.1444296698023;4075.2460794753065;4087.1825634873144;4092.7544347339253;4925.926111108336;4968.975155124202;5073.34046573943;5093.2360145977655;5119.820806271762;925.5141050948306;963.6241865672393;971.9368241064308;1050.238577031646;1059.4914441068331;681.6251061915926;692.1071817355655;696.1437431958719;696.2376198063113;705.0833915909298;12988.025898057684;13180.418349798085;13416.463341466428;14092.154470731788;14097.154170749787;674.6188403551978;695.8364784275691;713.390051505955;713.9464540159508;722.0324764815173;5205.141151709925;5217.947820521822;5279.076161671692;5332.413434522199;5380.7086299287885;93159;93706;97841;102375.4881225589;104381;87201;87500.5624971871;87592;87619.56190219008;89176;74796;75083.99999999891;78181.60909195417;80016.59991700004;80403.59798200971;11325;12382.442790074288;12609.43257553394;12729.936350318188;12870.356482175666;32917.01248962535;33566;35213;35319.470207947415;36265.637343627284;58619.70690146522;60360;63870.68064659647;64327.35672643214;65562.67218663877;17830;19254.7111793326;19282.517937051685;19405.70891436658;19633.901830490755;20486.692699609815;21119.894400527897;21141.682874756585;21153.57692846165;21803.89098054563;18644.813551864307;18990.620187596447;19198.8080119197;19436.2225510978;19636.018199089704;18893.433197004113;19436.805631943498;19838.90080549588;19873.503162421057;20082.698759518327;17294.033041405255;17443.476695699148;17857.910710446366;18110.094495275447;18374.35689750852;13775.38010789497;13808.516701915385;13820.308984550531;14017.579472615838;14185.148891066568;13790.379432925341;14026.08830426019;14138.635570838022;14670.046446980912;14679.192644404233 04:31:26 INFO - PID 11269 | __end_tp_report 04:31:26 INFO - PID 11269 | __start_cc_report 04:31:26 INFO - PID 11269 | _x_x_mozilla_cycle_collect,339 04:31:26 INFO - PID 11269 | __end_cc_report 04:31:26 INFO - PID 11269 | __startTimestamp1499686286458__endTimestamp 04:31:26 INFO - PID 11269 | 04:31:26 INFO - PID 11269 | ------- Summary: start ------- 04:31:26 INFO - PID 11269 | Number of tests: 6 04:31:26 INFO - PID 11269 | 04:31:26 INFO - PID 11269 | [#0] dojo.html Cycles:165 Average:6004.43 Median:6235.31 stddev:698.26 (11.2%) stddev-sans-first:660.94 04:31:26 INFO - PID 11269 | Values: 3054.4 3123.8 3128.2 3145.4 3161.9 5993.6 6004.2 6016.1 6029.9 6104.5 6045.3 6076.2 6084.6 6114.9 6115.2 5504.9 5548.0 5555.4 5571.2 5590.1 5576.8 5590.2 5592.9 5598.9 5618.3 5578.9 5581.7 5583.2 5588.9 5610.3 5542.8 5544.2 5553.9 5563.4 5567.4 5493.1 5522.4 5572.8 5634.8 5725.8 6116.1 6123.2 6130.4 6235.3 6235.5 6232.2 6350.4 6546.6 6645.2 6646.4 6510.4 6517.8 6538.2 6543.1 6548.1 6026.6 6027.9 6052.1 6070.3 6072.3 6596.3 6622.9 6638.9 6680.5 6685.9 6340.4 6434.1 6441.3 6499.9 6528.9 6542.4 6545.2 6622.1 6632.7 6663.5 6219.9 6251.3 6310.9 6316.7 6517.1 6413.6 6494.9 6528.8 6543.1 6602.7 5239.3 5292.3 5338.5 5399.4 5421.7 4525.8 4558.9 4571.2 4593.2 4596.2 5627.7 5641.0 5655.2 5673.7 5675.6 6498.3 6500.9 6522.3 6541.4 6549.9 5668.6 5674.6 5710.1 5791.9 5800.8 5731.7 5775.3 5818.0 5822.1 5824.8 6296.3 6328.1 6331.5 6341.2 6384.6 6480.3 6499.9 6553.8 6561.4 6570.0 6340.8 6352.0 6359.4 6389.0 6479.4 6386.6 6447.6 6452.2 6547.3 6550.0 6520.3 6599.8 6604.3 6628.9 6673.7 6111.8 6222.7 6225.7 6236.7 6456.4 6308.7 6336.1 6353.8 6355.1 6366.1 5080.2 6218.6 6261.0 6263.6 6301.6 6406.3 6416.8 6434.3 6502.1 6542.7 6172.8 6175.8 6235.5 6284.7 6292.5 04:31:26 INFO - PID 11269 | 04:31:26 INFO - PID 11269 | [#1] ext.html Cycles:180 Average:37838.77 Median:19025.68 stddev:53888.10 (283.2%) stddev-sans-first:53967.46 04:31:26 INFO - PID 11269 | Values: 787.7 813.5 841.2 874.7 875.0 40782.0 41945.0 42052.2 42251.8 42286.0 39057.6 39177.8 39255.6 39271.4 39291.4 6864.8 6980.8 6986.1 6998.5 7005.8 6928.4 6942.4 6978.5 7017.2 7020.1 6955.8 6973.5 7024.4 7033.1 7038.9 6902.7 6937.9 6946.8 6963.9 7000.5 6209.3 6231.7 6245.2 6251.4 6262.1 33286.5 33752.0 33867.0 33888.7 33930.8 3429.7 3431.9 3481.4 3503.9 3670.5 31181.7 31391.4 31523.7 31566.7 31691.8 4682.5 4897.2 4915.7 5001.5 5081.7 183828.0 183933.0 186402.1 196025.0 197325.0 43164.1 48598.8 49150.0 49183.8 49698.0 51548.0 51556.5 51699.0 51731.7 51808.7 16115.0 16173.7 16211.6 16229.4 16236.0 13477.3 13566.1 13569.1 13634.3 13656.7 14039.9 14139.7 14142.4 14173.0 14314.4 5478.9 5601.0 5609.2 5613.7 5742.9 990.9 1008.8 1013.7 1041.2 1041.9 22904.7 22911.4 23049.8 23607.8 23859.6 1080.7 1096.4 1119.9 1134.8 1149.7 12383.8 12492.4 12580.2 12610.0 12654.6 233678.0 234195.0 234368.0 234561.0 235137.0 53288.2 54244.6 54256.2 54558.0 54659.5 1415.6 1486.8 1489.0 1494.6 1502.1 22882.8 23038.2 23304.7 23497.4 23604.4 38711.2 38909.0 38949.4 39045.8 39121.2 194803.0 195432.0 195921.0 197609.0 197937.0 34570.0 36018.8 36405.3 38477.8 38748.0 45875.1 47442.3 47582.0 48089.8 48303.8 31742.2 33352.4 34074.7 34121.1 34354.7 33291.0 33398.2 34181.7 34453.3 34896.8 37643.8 37887.4 38116.4 38161.0 38224.0 31047.2 32496.8 33300.0 33605.5 33880.5 23424.8 24349.0 24874.6 24930.9 25011.5 04:31:26 INFO - PID 11269 | 04:31:26 INFO - PID 11269 | [#2] jquery.html Cycles:180 Average:34435.66 Median:22893.16 stddev:86933.26 (379.7%) stddev-sans-first:87139.92 04:31:26 INFO - PID 11269 | Values: 558.2 563.9 573.6 589.4 598.2 21820.6 22853.5 22874.9 22911.4 22934.7 23981.8 26414.9 26541.3 26640.2 26727.1 6529.2 6679.5 6681.4 6704.8 6722.3 6575.9 6620.4 6652.9 6696.1 6728.0 6157.2 6310.7 6417.7 6483.7 6637.0 6441.4 6465.4 6491.3 6510.8 6530.0 6042.9 6043.8 6050.4 6059.8 6065.7 26640.7 28270.3 28602.1 28704.0 28754.6 1950.4 1995.8 2009.9 2010.2 2016.8 18066.5 18663.9 18685.1 18687.4 18697.7 2344.8 2368.2 2412.4 2417.0 2435.1 124465.0 125623.0 127909.4 128229.0 129062.0 13539.7 13795.5 14279.6 14763.9 14933.6 23166.0 23248.5 23313.5 23345.4 23375.2 9778.7 10028.7 10059.5 10064.0 10120.6 9188.4 9326.0 9417.7 9420.4 9471.8 8900.4 8909.8 8945.6 9085.9 9095.7 2666.5 2732.5 2734.7 2739.4 2748.8 967.6 975.2 984.4 986.1 992.1 19303.1 19542.0 19743.0 19790.9 19945.8 982.1 1023.7 1046.9 1055.0 1063.9 10381.0 10736.5 10806.4 10913.2 10970.0 507976.0 513335.0 521475.0 521662.0 539079.0 107629.5 109538.0 110383.4 110567.0 112471.4 1280.7 1282.1 1317.0 1319.7 1327.7 17000.7 17015.3 17015.7 17021.4 17117.3 48502.8 50358.0 50634.0 50996.5 51021.2 67971.7 70135.3 72585.6 73446.0 74084.6 12601.7 13090.9 13468.0 13468.4 13470.1 18790.2 18836.4 18905.5 18949.6 19028.4 16003.3 16140.0 16163.4 16176.1 16243.5 13901.0 13907.6 14240.1 14753.9 15279.8 16479.7 16588.3 16633.8 16644.5 16651.2 13148.2 13253.9 13326.9 13418.2 13464.3 14954.3 15003.3 15175.0 15187.2 15214.5 04:31:26 INFO - PID 11269 | 04:31:26 INFO - PID 11269 | [#3] mootools.html Cycles:180 Average:8269.36 Median:2615.71 stddev:5617.16 (214.7%) stddev-sans-first:5608.82 04:31:26 INFO - PID 11269 | Values: 1345.3 1389.7 1397.5 1399.9 1407.7 13247.5 13284.1 13815.3 13975.2 13991.0 13179.7 14160.8 14185.5 14225.4 14254.6 2633.7 2682.7 2685.9 2692.7 2694.7 2552.9 2601.3 2607.6 2618.8 2620.1 2454.5 2590.2 2612.6 2638.9 2647.3 2596.2 2695.5 2698.2 2700.8 2704.1 2544.6 2550.5 2563.6 2574.2 2581.9 13047.2 13340.4 13349.7 13363.2 13382.0 7311.2 7624.1 7624.6 7643.4 7646.0 4981.9 5036.1 5056.3 5120.8 5182.5 1758.5 1813.6 1839.1 1860.2 1882.2 22084.3 22174.4 22234.4 22252.8 22365.6 5938.1 6016.6 6239.0 6285.0 6293.7 14982.3 15203.6 15208.1 15255.3 15295.4 7035.9 7170.7 7192.1 7199.2 7209.9 6514.5 6622.5 6625.2 6738.5 6750.1 4677.9 4860.0 4894.5 4919.7 5054.3 1334.2 1356.6 1371.1 1385.8 1386.2 829.1 858.3 859.9 866.6 891.8 6914.7 6924.6 6971.3 6994.2 7078.0 693.3 705.8 740.4 745.2 746.3 4381.8 4869.5 4932.2 5044.7 5086.2 17534.7 17860.3 18012.7 18124.2 18147.8 17263.9 17628.8 17732.6 17936.7 17978.6 10227.2 10240.9 10260.6 10520.6 10660.7 7219.9 7255.2 7274.9 7308.0 7344.2 14520.9 15417.9 15532.9 15986.5 16032.9 16346.7 16507.8 16719.7 16746.7 16827.5 9943.0 9950.2 9962.7 10002.9 10029.4 12533.6 12706.2 12715.4 12830.9 12931.7 10200.0 10413.9 10442.5 10747.4 10800.3 9519.5 9553.5 9909.3 10095.7 10430.9 8860.8 8950.5 8986.1 9000.0 9005.8 6771.3 6913.7 6957.8 6987.4 6995.2 6183.5 6186.5 6248.5 6298.5 6320.6 04:31:26 INFO - PID 11269 | 04:31:26 INFO - PID 11269 | [#4] prototype.html Cycles:180 Average:5392.08 Median:5985.08 stddev:1506.82 (25.2%) stddev-sans-first:1465.45 04:31:26 INFO - PID 11269 | Values: 490.9 501.1 512.9 520.0 524.1 5979.8 6182.2 6182.9 6185.1 6189.7 5763.7 6017.3 6039.2 6064.7 6092.1 4933.5 4934.2 4974.3 4975.6 5002.8 4927.8 4977.6 4981.9 4986.0 5008.0 4674.9 4850.2 4890.9 4905.5 4928.8 4760.9 4818.0 4839.2 4858.3 4891.9 4360.3 4372.8 4373.8 4384.1 4395.6 5857.2 5865.8 5954.8 5990.4 5992.4 5471.4 5539.0 5573.3 5632.5 5654.1 6433.8 6440.6 6454.3 6464.5 6479.4 4797.0 4803.8 4818.2 4845.5 4851.1 6765.3 6786.4 6787.2 6840.6 6854.8 4917.6 4958.2 4970.0 4980.5 4991.8 4925.1 4968.0 4973.3 5003.4 5019.9 5506.8 5510.9 5534.5 5565.5 5566.4 6333.0 6369.7 6421.0 6428.5 6432.8 1716.4 1722.9 1734.9 1736.1 1742.7 1097.9 1134.0 1193.8 1205.7 1220.4 5473.2 5606.4 5629.5 5660.2 5704.7 6420.4 6462.8 6496.9 6517.5 6519.4 5552.9 5657.6 5658.4 5661.3 5679.5 3398.4 3446.6 3496.4 3509.0 3522.3 6301.8 6319.9 6365.5 6408.2 6429.1 6565.2 6590.1 6599.7 6616.6 6776.6 6299.7 6319.8 6368.4 6373.2 6409.2 6599.5 6618.8 6628.8 6657.3 6658.3 6408.0 6455.7 6459.2 6609.4 6619.1 6342.9 6344.5 6366.6 6383.9 6384.5 4823.4 4871.3 4924.9 4928.4 4945.2 6495.0 6558.0 6603.1 6619.3 6658.6 6218.8 6340.2 6380.3 6390.9 6419.0 6200.3 6305.8 6306.6 6345.8 6428.3 6237.5 6275.5 6277.5 6284.2 6351.2 6385.8 6400.0 6411.9 6444.7 6484.9 5967.0 6115.3 6209.2 6243.9 6282.4 04:31:26 INFO - PID 11269 | 04:31:26 INFO - PID 11269 | [#5] yui.html Cycles:180 Average:21808.51 Median:20058.45 stddev:27862.06 (138.9%) stddev-sans-first:27895.88 04:31:26 INFO - PID 11269 | Values: 874.4 910.7 928.2 934.3 937.7 16191.3 16226.0 16269.9 16288.6 18232.6 19521.5 20495.3 21100.0 21308.4 21390.6 1022.6 1038.0 1042.9 1044.7 1046.2 1053.2 1053.6 1063.7 1065.8 1066.7 991.2 1045.2 1095.7 1105.6 1115.3 1074.7 1077.9 1078.7 1079.0 1079.7 790.3 793.0 793.4 794.4 795.7 17275.7 17451.6 17470.7 17504.3 19367.6 19203.9 19907.7 20034.2 20145.4 20284.9 15628.4 15967.3 15984.4 15998.0 16001.1 3522.3 3548.1 3550.6 3573.4 3575.2 101695.0 101868.0 105787.5 105944.5 106609.0 14956.3 15148.3 15181.9 15351.2 15495.8 23234.0 28473.3 28597.7 28687.4 28752.3 8477.2 8635.1 8679.7 8703.6 8723.1 3949.6 4074.1 4075.2 4087.2 4092.8 4925.9 4969.0 5073.3 5093.2 5119.8 925.5 963.6 971.9 1050.2 1059.5 681.6 692.1 696.1 696.2 705.1 12988.0 13180.4 13416.5 14092.2 14097.2 674.6 695.8 713.4 713.9 722.0 5205.1 5217.9 5279.1 5332.4 5380.7 93159.0 93706.0 97841.0 102375.5 104381.0 87201.0 87500.6 87592.0 87619.6 89176.0 74796.0 75084.0 78181.6 80016.6 80403.6 11325.0 12382.4 12609.4 12729.9 12870.4 32917.0 33566.0 35213.0 35319.5 36265.6 58619.7 60360.0 63870.7 64327.4 65562.7 17830.0 19254.7 19282.5 19405.7 19633.9 20486.7 21119.9 21141.7 21153.6 21803.9 18644.8 18990.6 19198.8 19436.2 19636.0 18893.4 19436.8 19838.9 19873.5 20082.7 17294.0 17443.5 17857.9 18110.1 18374.4 13775.4 13808.5 13820.3 14017.6 14185.1 13790.4 14026.1 14138.6 14670.0 14679.2 04:31:26 INFO - PID 11269 | -------- Summary: end -------- 04:31:26 INFO - PID 11269 | 04:31:27 INFO - TEST-INFO | 11269: exit 0 04:31:27 INFO - TEST-OK | dromaeo_css | took 1113686ms 04:31:27 INFO - TEST-START | kraken 04:31:27 INFO - Initialising browser for kraken test... 04:31:27 INFO - Application command: /builds/slave/test/build/application/firefox/firefox http://localhost:50872/getInfo.html -profile /tmp/tmp7tBo8n/profile 04:31:27 INFO - TEST-INFO | started process 11686 (/builds/slave/test/build/application/firefox/firefox http://localhost:50872/getInfo.html) 04:31:34 INFO - TEST-INFO | 11686: exit 0 04:31:34 INFO - Browser initialized. 04:31:34 INFO - Running cycle 1/1 for kraken test... 04:31:34 INFO - TEST-INFO | started process 11909 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp7tBo8n/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpnoisy -tpcycles 1 -tppagecycles 1) 04:31:46 INFO - PID 11909 | RSS: Main: 173694976 04:31:46 INFO - PID 11909 | 04:31:48 INFO - PID 11909 | Cycle 1(1): loaded http://localhost:50872/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:50872/tests/kraken/driver.html?testName=audio-beat-detection) 04:31:49 INFO - PID 11909 | RSS: Main: 179617792 04:31:49 INFO - PID 11909 | 04:31:52 INFO - PID 11909 | Cycle 1(1): loaded http://localhost:50872/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:50872/tests/kraken/driver.html?testName=audio-dft) 04:31:52 INFO - PID 11909 | RSS: Main: 179650560 04:31:52 INFO - PID 11909 | 04:31:55 INFO - PID 11909 | Cycle 1(1): loaded http://localhost:50872/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:50872/tests/kraken/driver.html?testName=audio-fft) 04:31:56 INFO - PID 11909 | RSS: Main: 172892160 04:31:56 INFO - PID 11909 | 04:31:58 INFO - PID 11909 | Cycle 1(1): loaded http://localhost:50872/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:50872/tests/kraken/driver.html?testName=audio-oscillator) 04:31:58 INFO - PID 11909 | RSS: Main: 173694976 04:31:58 INFO - PID 11909 | 04:32:01 INFO - PID 11909 | Cycle 1(1): loaded http://localhost:50872/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:50872/tests/kraken/driver.html?testName=imaging-gaussian-blur) 04:32:01 INFO - PID 11909 | RSS: Main: 173608960 04:32:01 INFO - PID 11909 | 04:32:04 INFO - PID 11909 | Cycle 1(1): loaded http://localhost:50872/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:50872/tests/kraken/driver.html?testName=imaging-darkroom) 04:32:05 INFO - PID 11909 | RSS: Main: 177598464 04:32:05 INFO - PID 11909 | 04:32:08 INFO - PID 11909 | Cycle 1(1): loaded http://localhost:50872/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:50872/tests/kraken/driver.html?testName=imaging-desaturate) 04:32:09 INFO - PID 11909 | RSS: Main: 178941952 04:32:09 INFO - PID 11909 | 04:32:12 INFO - PID 11909 | Cycle 1(1): loaded http://localhost:50872/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:50872/tests/kraken/driver.html?testName=json-parse-financial) 04:32:12 INFO - PID 11909 | RSS: Main: 177700864 04:32:12 INFO - PID 11909 | 04:32:14 INFO - PID 11909 | Cycle 1(1): loaded http://localhost:50872/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:50872/tests/kraken/driver.html?testName=json-stringify-tinderbox) 04:32:15 INFO - PID 11909 | RSS: Main: 177643520 04:32:15 INFO - PID 11909 | 04:32:16 INFO - PID 11909 | Cycle 1(1): loaded http://localhost:50872/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:50872/tests/kraken/driver.html?testName=stanford-crypto-aes) 04:32:17 INFO - PID 11909 | RSS: Main: 177528832 04:32:17 INFO - PID 11909 | 04:32:19 INFO - PID 11909 | Cycle 1(1): loaded http://localhost:50872/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:50872/tests/kraken/driver.html?testName=stanford-crypto-ccm) 04:32:20 INFO - PID 11909 | RSS: Main: 177631232 04:32:20 INFO - PID 11909 | 04:32:22 INFO - PID 11909 | Cycle 1(1): loaded http://localhost:50872/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:50872/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 04:32:23 INFO - PID 11909 | RSS: Main: 177532928 04:32:23 INFO - PID 11909 | 04:32:26 INFO - PID 11909 | Cycle 1(1): loaded http://localhost:50872/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:50872/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 04:32:27 INFO - PID 11909 | RSS: Main: 177459200 04:32:27 INFO - PID 11909 | 04:32:28 INFO - PID 11909 | Cycle 1(1): loaded http://localhost:50872/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:50872/tests/kraken/driver.html?testName=ai-astar) 04:32:29 INFO - PID 11909 | RSS: Main: 178573312 04:32:29 INFO - PID 11909 | 04:32:29 INFO - PID 11909 | __start_tp_report 04:32:29 INFO - PID 11909 | _x_x_mozilla_page_load 04:32:29 INFO - PID 11909 | _x_x_mozilla_page_load_details 04:32:29 INFO - PID 11909 | |i|pagename|runs| 04:32:29 INFO - PID 11909 | |0;ai-astar;102;106;109;108;113;111;111;108;109;108 04:32:29 INFO - PID 11909 | |1;audio-beat-detection;148;121;156;179;123;150;149;122;169;122 04:32:29 INFO - PID 11909 | |2;audio-dft;164;166;164;164;164;162;162;169;168;164 04:32:29 INFO - PID 11909 | |3;audio-fft;76;74;77;163;75;76;74;73;95;75 04:32:29 INFO - PID 11909 | |4;audio-oscillator;82;81;144;83;82;81;137;82;81;128 04:32:29 INFO - PID 11909 | |5;imaging-gaussian-blur;115;114;114;114;114;113;113;113;114;113 04:32:29 INFO - PID 11909 | |6;imaging-darkroom;148;149;148;149;150;152;150;150;151;149 04:32:29 INFO - PID 11909 | |7;imaging-desaturate;94;96;94;93;94;102;95;94;95;95 04:32:29 INFO - PID 11909 | |8;json-parse-financial;60;56;56;55;57;57;55;59;56;60 04:32:29 INFO - PID 11909 | |9;json-stringify-tinderbox;53;53;54;54;57;53;54;54;56;54 04:32:29 INFO - PID 11909 | |10;stanford-crypto-aes;78;80;78;78;79;77;87;78;79;80 04:32:29 INFO - PID 11909 | |11;stanford-crypto-ccm;126;128;129;128;127;127;127;127;126;158 04:32:29 INFO - PID 11909 | |12;stanford-crypto-pbkdf2;184;189;178;203;180;177;176;184;178;182 04:32:29 INFO - PID 11909 | |13;stanford-crypto-sha256-iterative;70;70;69;68;77;68;73;72;68;67 04:32:29 INFO - PID 11909 | __end_tp_report 04:32:29 INFO - PID 11909 | __start_cc_report 04:32:29 INFO - PID 11909 | _x_x_mozilla_cycle_collect,921 04:32:29 INFO - PID 11909 | __end_cc_report 04:32:29 INFO - PID 11909 | __startTimestamp1499686349156__endTimestamp 04:32:29 INFO - PID 11909 | 04:32:29 INFO - PID 11909 | ------- Summary: start ------- 04:32:29 INFO - PID 11909 | Number of tests: 14 04:32:29 INFO - PID 11909 | 04:32:29 INFO - PID 11909 | [#0] ai-astar Cycles:10 Average:108.50 Median:109.00 stddev:3.03 (2.8%) stddev-sans-first:2.11 04:32:29 INFO - PID 11909 | Values: 102.0 106.0 109.0 108.0 113.0 111.0 111.0 108.0 109.0 108.0 04:32:29 INFO - PID 11909 | 04:32:29 INFO - PID 11909 | [#1] audio-beat-detection Cycles:10 Average:143.90 Median:149.50 stddev:21.11 (14.1%) stddev-sans-first:22.33 04:32:29 INFO - PID 11909 | Values: 148.0 121.0 156.0 179.0 123.0 150.0 149.0 122.0 169.0 122.0 04:32:29 INFO - PID 11909 | 04:32:29 INFO - PID 11909 | [#2] audio-dft Cycles:10 Average:164.70 Median:164.00 stddev:2.31 (1.4%) stddev-sans-first:2.44 04:32:29 INFO - PID 11909 | Values: 164.0 166.0 164.0 164.0 164.0 162.0 162.0 169.0 168.0 164.0 04:32:29 INFO - PID 11909 | 04:32:29 INFO - PID 11909 | [#3] audio-fft Cycles:10 Average:85.80 Median:75.50 stddev:27.87 (36.9%) stddev-sans-first:29.33 04:32:29 INFO - PID 11909 | Values: 76.0 74.0 77.0 163.0 75.0 76.0 74.0 73.0 95.0 75.0 04:32:29 INFO - PID 11909 | 04:32:29 INFO - PID 11909 | [#4] audio-oscillator Cycles:10 Average:98.10 Median:81.50 stddev:26.66 (32.7%) stddev-sans-first:27.63 04:32:29 INFO - PID 11909 | Values: 82.0 81.0 144.0 83.0 82.0 81.0 137.0 82.0 81.0 128.0 04:32:29 INFO - PID 11909 | 04:32:29 INFO - PID 11909 | [#5] imaging-gaussian-blur Cycles:10 Average:113.70 Median:114.00 stddev:0.67 (0.6%) stddev-sans-first:0.53 04:32:29 INFO - PID 11909 | Values: 115.0 114.0 114.0 114.0 114.0 113.0 113.0 113.0 114.0 113.0 04:32:29 INFO - PID 11909 | 04:32:29 INFO - PID 11909 | [#6] imaging-darkroom Cycles:10 Average:149.60 Median:150.00 stddev:1.26 (0.8%) stddev-sans-first:1.20 04:32:29 INFO - PID 11909 | Values: 148.0 149.0 148.0 149.0 150.0 152.0 150.0 150.0 151.0 149.0 04:32:29 INFO - PID 11909 | 04:32:29 INFO - PID 11909 | [#7] imaging-desaturate Cycles:10 Average:95.20 Median:94.50 stddev:2.53 (2.7%) stddev-sans-first:2.65 04:32:29 INFO - PID 11909 | Values: 94.0 96.0 94.0 93.0 94.0 102.0 95.0 94.0 95.0 95.0 04:32:29 INFO - PID 11909 | 04:32:29 INFO - PID 11909 | [#8] json-parse-financial Cycles:10 Average:57.10 Median:57.00 stddev:1.91 (3.4%) stddev-sans-first:1.72 04:32:29 INFO - PID 11909 | Values: 60.0 56.0 56.0 55.0 57.0 57.0 55.0 59.0 56.0 60.0 04:32:29 INFO - PID 11909 | 04:32:29 INFO - PID 11909 | [#9] json-stringify-tinderbox Cycles:10 Average:54.20 Median:54.00 stddev:1.32 (2.4%) stddev-sans-first:1.32 04:32:29 INFO - PID 11909 | Values: 53.0 53.0 54.0 54.0 57.0 53.0 54.0 54.0 56.0 54.0 04:32:29 INFO - PID 11909 | 04:32:29 INFO - PID 11909 | [#10] stanford-crypto-aes Cycles:10 Average:79.40 Median:79.00 stddev:2.84 (3.6%) stddev-sans-first:2.96 04:32:29 INFO - PID 11909 | Values: 78.0 80.0 78.0 78.0 79.0 77.0 87.0 78.0 79.0 80.0 04:32:29 INFO - PID 11909 | 04:32:29 INFO - PID 11909 | [#11] stanford-crypto-ccm Cycles:10 Average:130.30 Median:127.50 stddev:9.78 (7.7%) stddev-sans-first:10.24 04:32:29 INFO - PID 11909 | Values: 126.0 128.0 129.0 128.0 127.0 127.0 127.0 127.0 126.0 158.0 04:32:29 INFO - PID 11909 | 04:32:29 INFO - PID 11909 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:183.10 Median:183.00 stddev:8.05 (4.4%) stddev-sans-first:8.53 04:32:29 INFO - PID 11909 | Values: 184.0 189.0 178.0 203.0 180.0 177.0 176.0 184.0 178.0 182.0 04:32:29 INFO - PID 11909 | 04:32:29 INFO - PID 11909 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:70.20 Median:70.00 stddev:3.05 (4.4%) stddev-sans-first:3.23 04:32:29 INFO - PID 11909 | Values: 70.0 70.0 69.0 68.0 77.0 68.0 73.0 72.0 68.0 67.0 04:32:29 INFO - PID 11909 | -------- Summary: end -------- 04:32:29 INFO - PID 11909 | 04:32:29 INFO - PID 11909 | *** UTM:SVC TimerManager:registerTimer called after profile-before-change notification. Ignoring timer registration for id: telemetry_modules_ping 04:32:29 INFO - TEST-INFO | 11909: exit 0 04:32:29 INFO - TEST-OK | kraken | took 62874ms 04:32:29 INFO - SUITE-END | took 1176s 04:32:30 INFO - Completed test suite (00:19:36) 04:32:30 INFO - javascript benchmark 04:32:30 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": ["e10s"], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 8238.590760056952, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3054.419660264551, 3123.7813353065285, 3128.1866714654197, 3145.4023735490255, 3161.9367612647757, 5993.640381577103, 6004.219451471308, 6016.067509536029, 6029.939700602988, 6104.5116390688745, 6045.33501314855, 6076.179715738374, 6084.574079814403, 6114.938850611493, 6115.235595550556, 5504.944950550484, 5548.001359755252, 5555.444455554452, 5571.247881536002, 5590.133529302964, 5576.832695019156, 5590.161475778625, 5592.86017849553, 5598.860028499279, 5618.269624948751, 5578.8605284868, 5581.7209139543065, 5583.218349431063, 5588.91616625751, 5610.298712660918, 5542.8337149885565, 5544.16837474378, 5553.861153471175, 5563.388027316992, 5567.415421380778, 5493.093639549509, 5522.392536820947, 5572.7770889164385, 5634.774609015634, 5725.828225153252, 6116.113163591299, 6123.234595675541, 6130.4176103270565, 6235.314115447297, 6235.501159907197, 6232.158658581124, 6350.396712312323, 6546.574472659262, 6645.169353830771, 6646.401823835878, 6510.381513756186, 6517.804465865985, 6538.150040494753, 6543.116679248288, 6548.083268342436, 6026.578139530191, 6027.939720602782, 6052.122442245894, 6070.271567411939, 6072.301685306202, 6596.340365963365, 6622.940329547249, 6638.86722265552, 6680.498962577826, 6685.866282674319, 6340.365963403715, 6434.131392262078, 6441.25925518562, 6499.927511960474, 6528.934710652928, 6542.411182993554, 6545.247296560861, 6622.139121914121, 6632.734690612321, 6663.500237482208, 6219.875602487925, 6251.3123556408755, 6310.9368906311265, 6316.715747791361, 6517.120188774455, 6413.583117097373, 6494.870102598016, 6528.836779080466, 6543.149390579194, 6602.73589056442, 5239.292695486137, 5292.259083728204, 5338.46615338463, 5399.406065332811, 5421.674699518042, 4525.7510836904285, 4558.88602784933, 4571.245744452194, 4593.173228818845, 4596.195665758479, 5627.690477023803, 5640.971795140998, 5655.1799989001365, 5673.659580425187, 5675.574331925122, 6498.317676643885, 6500.902486462707, 6522.34776522344, 6541.443977261891, 6549.869002619921, 5668.57485688575, 5674.574406919415, 5710.057840456361, 5791.884162316815, 5800.8259752207505, 5731.684757338387, 5775.27809023872, 5818.010938140442, 5822.068469045017, 5824.767009319579, 6296.275928268216, 6328.145700330489, 6331.525135614847, 6341.175647165839, 6384.553081284265, 6480.287168411565, 6499.935000649933, 6553.803385898431, 6561.376669216417, 6570.0, 6340.841478963062, 6352.047192920914, 6359.427651511386, 6389.0, 6479.449246814073, 6386.552941294065, 6447.580907241015, 6452.161219041494, 6547.345265473415, 6549.967250163719, 6520.282768895512, 6599.8020059398295, 6604.306547812603, 6628.867422651423, 6673.666316684244, 6111.786087486917, 6222.657753823583, 6225.719842607003, 6236.688165591793, 6456.386643268882, 6308.747650093945, 6336.112944187726, 6353.777617783356, 6355.110284560073, 6366.076918846834, 5080.173265445697, 6218.595791273553, 6260.998240281533, 6263.592866463665, 6301.6219026858535, 6406.327335629878, 6416.7754128605275, 6434.324395938546, 6502.089707441057, 6542.705578248895, 6172.845678858064, 6175.814725558241, 6235.532335074797, 6284.74861005573, 6292.4966002720585], "value": 5953.700941240779, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [787.6888628991549, 813.4875028731898, 841.1966571923812, 874.6763697431951, 874.9912500874991, 40782.0, 41945.0, 42052.158956820844, 42251.78874105633, 42286.0, 39057.60942390575, 39177.80411097948, 39255.607443925626, 39271.41092883609, 39291.41062884059, 6864.828379290508, 6980.790576282694, 6986.126734158231, 6998.545094568837, 7005.754798582051, 6928.44572434204, 6942.444604431658, 6978.511504194708, 7017.157941047081, 7020.122484689414, 6955.826104347381, 6973.546719463244, 7024.4029257513175, 7033.085698859141, 7038.85922281554, 6902.654867256617, 6937.861242775141, 6946.79159625212, 6963.930360696404, 7000.5099643025005, 6209.316975132731, 6231.6572588507615, 6245.188125543696, 6251.437370636664, 6262.091996660459, 33286.50070248948, 33752.0, 33867.0, 33888.66111338904, 33930.83034584836, 3429.657034296575, 3431.9313613727836, 3481.3559491494157, 3503.9474407883904, 3670.5228320318456, 31181.688183118105, 31391.37217255665, 31523.684763152305, 31566.684333156605, 31691.84154079238, 4682.461516925563, 4897.240927656183, 4915.729634870081, 5001.4998500149695, 5081.66969147008, 183828.0, 183933.0, 186402.06798966054, 196025.0, 197325.0, 43164.13671726548, 48598.75700621474, 49150.0, 49183.75408122937, 49698.0, 51547.96904061898, 51556.484435155166, 51699.0, 51731.741341293804, 51808.74095629573, 16115.0, 16173.676526469404, 16211.594710132105, 16229.431969881234, 16236.0, 13477.258750768802, 13566.050376473551, 13569.118007329493, 13634.318284085755, 13656.726865462635, 14039.859601403856, 14139.717205655828, 14142.43430262778, 14173.0, 14314.355853986595, 5478.945210547923, 5601.0, 5609.214709940612, 5613.747381367848, 5742.942570574324, 990.8761404824397, 1008.7578981044643, 1013.690824298596, 1041.1670663469195, 1041.8958104189521, 22904.65643015356, 22911.427214319774, 23049.769502304764, 23607.763922360555, 23859.64210536843, 1080.6541906589973, 1096.4079397125463, 1119.8656161260537, 1134.7560274541013, 1149.735560821016, 12383.814242786366, 12492.375381230902, 12580.182288151424, 12610.0, 12654.557090501788, 233678.0, 234195.0, 234368.0, 234561.0, 235137.0, 53288.20067698987, 54244.64388390243, 54256.186157207674, 54558.0, 54659.45340546623, 1415.6248594122567, 1486.7695507196402, 1489.0098084773722, 1494.5889880282791, 1502.1212590634382, 22882.771172288063, 23038.193663222377, 23304.650430243222, 23497.41256468602, 23604.411610656658, 38711.2257754849, 38909.0, 38949.415758763076, 39045.8047709771, 39121.217575648894, 194803.0, 195432.0, 195921.0, 197609.0, 197937.0, 34570.0, 36018.8199059003, 36405.27189456249, 38477.80761096177, 38748.0, 45875.082498350515, 47442.28836567523, 47582.0, 48089.75955120202, 48303.75848120737, 31742.206444839063, 33352.40473833219, 34074.659253407146, 34121.146971325914, 34354.656453436146, 33291.0, 33398.16504587405, 34181.65818341785, 34453.310933781686, 34896.82551587226, 37643.81178094092, 37887.43168852525, 38116.428253575665, 38161.0, 38224.0, 31047.223819403793, 32496.83751581227, 33300.0, 33605.495917560766, 33880.49179262264, 23424.765752342257, 24349.0, 24874.626880597167, 24930.87534562388, 25011.499770004135], "value": 17022.76970395088, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [558.2157069317608, 563.9323281206256, 573.6318879472457, 589.3752622220445, 598.2282855116898, 21820.563588728237, 22853.542929141408, 22874.88562557189, 22911.42721431965, 22934.65598016031, 23981.76018239817, 26414.867925660394, 26541.336466588346, 26640.200793976164, 26727.06455274061, 6529.15121034266, 6679.499037572177, 6681.432078273353, 6704.832379190535, 6722.327767223263, 6575.868482630344, 6620.437262832641, 6652.93347066528, 6696.096027036337, 6728.0, 6157.168782214411, 6310.684465776716, 6417.7112029958535, 6483.7082331295205, 6636.966815165917, 6441.420272175504, 6465.418112369909, 6491.253505846841, 6510.772122975721, 6529.967350163242, 6042.939570604326, 6043.758249670008, 6050.425209605124, 6059.757609695607, 6065.727042283108, 26640.73359266402, 28270.293242668893, 28602.14193574196, 28704.0, 28754.568681469795, 1950.3856285270094, 1995.760508738946, 2009.9196032158695, 2010.1858747207405, 2016.8184863362367, 18066.458006259832, 18663.906680466647, 18685.06574671261, 18687.43937681872, 18697.719534206997, 2344.824138189643, 2368.2184878990065, 2412.372783076395, 2417.0452671194957, 2435.0990133650484, 124465.0, 125623.0, 127909.36045319714, 128229.0, 129061.99999999905, 13539.729205415837, 13795.517156899461, 14279.57161285163, 14763.852361476462, 14933.626659333604, 23166.0, 23248.53502929932, 23313.533729325656, 23345.41636459102, 23375.181868634518, 9778.65774697882, 10028.749281267881, 10059.5473203706, 10064.0, 10120.59517619287, 9188.40275382098, 9325.953370233105, 9417.717468475958, 9420.434773913586, 9471.810563788686, 8900.42147260426, 8909.821803563893, 8945.642174312954, 9085.863712044325, 9095.681651142311, 2666.4667066586762, 2732.49448851963, 2734.6991830898587, 2739.397332586828, 2748.848813315247, 967.6226271754022, 975.2246963663904, 984.4290311619244, 986.1075726467415, 992.1467537917385, 19303.131359088875, 19542.0, 19743.0, 19790.901045494968, 19945.800541994686, 982.1013772398176, 1023.6928921323573, 1046.9110125639254, 1054.9894501055044, 1063.8882917293572, 10380.97570973653, 10736.516856741466, 10806.405647689453, 10913.181511386678, 10970.0, 507976.0, 513335.0, 521475.0, 521662.0, 539079.0, 107629.46185269023, 109538.0, 110383.44808276067, 110567.0, 112471.43764281126, 1280.6542233596876, 1282.0576875996321, 1316.967075823112, 1319.6766792135988, 1327.6879933215687, 17000.74498882493, 17015.319387224867, 17015.744763828305, 17021.40425085116, 17117.315307387566, 48502.757486212344, 50358.0, 50634.0, 50996.49003510066, 51021.234681479065, 67971.66014169897, 70135.29864701288, 72585.6370718143, 73446.0, 74084.62957685177, 12601.747965040831, 13090.869091309345, 13467.989900757679, 13468.393922273326, 13470.124441911245, 18790.24839006479, 18836.434906952814, 18905.527361816065, 18949.621007580048, 19028.429147125054, 16003.279852406902, 16140.0, 16163.353465861233, 16176.110313932846, 16243.51269461918, 13901.0, 13907.58277251684, 14240.145591264558, 14753.92623036878, 15279.847201527842, 16479.670406592042, 16588.253528591486, 16633.750493742362, 16644.50066498007, 16651.16744162763, 13148.211107333591, 13253.867461325262, 13326.9333653335, 13418.194908305533, 13464.259465729087, 14954.327055282756, 15003.324850381978, 15175.0, 15187.164705940837, 15214.467493637669], "value": 11547.147090309272, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1345.2937207965817, 1389.7081612861298, 1397.4899161805945, 1399.930003499826, 1407.725493528762, 13247.470101195953, 13284.13653112547, 13815.30923453827, 13975.16149031059, 13991.0, 13179.73640527189, 14160.787588186186, 14185.503507377243, 14225.430982760703, 14254.572362829105, 2633.723459036802, 2682.745139211772, 2685.932851678714, 2692.67687877455, 2694.730526947309, 2552.8978840846435, 2601.2586412872333, 2607.5958226474927, 2618.7643112119904, 2620.109162884619, 2454.472288457981, 2590.2358804152727, 2612.6472926154916, 2638.93402664933, 2647.3381654586356, 2596.2341109372687, 2695.5417579011614, 2698.17705599792, 2700.8379497230035, 2704.1211606227857, 2544.6183072539084, 2550.5409026375246, 2563.5898256279092, 2574.1633968959977, 2581.922542323733, 13047.217166970013, 13340.399682014333, 13349.666258343523, 13363.198208107544, 13382.0, 7311.195768465464, 7624.085109786805, 7624.580648064354, 7643.350315223212, 7646.0, 4981.9252711209365, 5036.104240061943, 5056.292119103328, 5120.795168193268, 5182.481751824787, 1758.5339884930504, 1813.6010077782867, 1839.0988415676222, 1860.2466001269509, 1882.2471011595335, 22084.33746987593, 22174.445638859157, 22234.444138896655, 22252.777472225232, 22365.552688946293, 5938.109283607407, 6016.578839481282, 6239.0, 6285.0, 6293.716782744787, 14982.325795339018, 15203.619909502351, 15208.08751474915, 15255.313510891814, 15295.388184472497, 7035.92964070363, 7170.749023784142, 7192.136943566806, 7199.2080871104135, 7209.927900721031, 6514.478841692653, 6622.470202383798, 6625.238097618739, 6738.494612904052, 6750.122484077038, 4677.859664210079, 4859.975700121548, 4894.510548945077, 4919.65562410635, 5054.267131265946, 1334.152812963775, 1356.620146359021, 1371.1293328736324, 1385.7852032934709, 1386.1544457880684, 829.1169904052165, 858.2919091749332, 859.8882145321069, 866.6316815353449, 891.8483857744199, 6914.654267286615, 6924.61914594692, 6971.3028697129885, 6994.195667498201, 7078.0444639973975, 693.2997672350962, 705.7953193573909, 740.3558903753768, 745.187745357552, 746.2500187311825, 4381.824727010948, 4869.537393947569, 4932.21084626458, 5044.697318160922, 5086.21163719624, 17534.736978945326, 17860.28558857657, 18012.729809052875, 18124.184411701506, 18147.818521814614, 17263.913680431517, 17628.823711762976, 17732.556686082695, 17936.730949035777, 17978.5505362367, 10227.232957528364, 10240.948795255976, 10260.589576417009, 10520.631777887736, 10660.733481663021, 7219.927800721925, 7255.2019277878335, 7274.854502909806, 7308.0, 7344.22885597026, 14520.85479145195, 15417.922910385376, 15532.92233538825, 15986.520404387888, 16032.919835400748, 16346.67306653884, 16507.83492165063, 16719.749203762196, 16746.665066698843, 16827.495175144766, 9942.950285248528, 9950.154236889946, 9962.701118966443, 10002.949985250318, 10029.398236105857, 12533.623991280276, 12706.237625742486, 12715.364231788188, 12830.935845320713, 12931.676708082374, 10200.0, 10413.895861041596, 10442.477876106317, 10747.408892510673, 10800.297980631234, 9519.476428796483, 9553.522323883639, 9909.256805739455, 10095.7476063099, 10430.895691043295, 8860.822783544421, 8950.462972221687, 8986.101389861224, 8999.955000224956, 9005.7748556284, 6771.255161932085, 6913.654317284217, 6957.756478523227, 6987.441004719712, 6995.230524642184, 6183.536234782499, 6186.536009799193, 6248.5313601479165, 6298.527610429144, 6320.62076275425], "value": 6047.760547844536, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [490.8510020331104, 501.1127651107606, 512.8974205158968, 519.9584033277338, 524.0697761473386, 5979.760809567612, 6182.196314479117, 6182.938170618292, 6185.062340153458, 6189.659568723719, 5763.740631671574, 6017.338092809799, 6039.154518367421, 6064.727087281072, 6092.116643086761, 4933.481984391641, 4934.21052631579, 4974.278729584208, 4975.601951843862, 5002.849914502553, 4927.827526036589, 4977.55202031817, 4981.875453113665, 4986.0, 5008.0, 4674.90650186996, 4850.199717046683, 4890.902181956359, 4905.460399356086, 4928.827491037814, 4760.928586071212, 4818.024609909938, 4839.249916262985, 4858.271259311096, 4891.893647533806, 4360.345948107777, 4372.825086996516, 4373.7813109344725, 4384.145091707119, 4395.560443955611, 5857.150713146612, 5865.765369385262, 5954.75465871097, 5990.400959904018, 5992.43071908168, 5471.398146203915, 5538.972305138489, 5573.27547418837, 5632.549396048306, 5654.123610840285, 6433.774817881398, 6440.645764482952, 6454.32229615893, 6464.547481676284, 6479.35206479353, 4797.0, 4803.814264509675, 4818.229083346648, 4845.491223421525, 4851.10254602896, 6765.323467653245, 6786.3892249697765, 6787.16746478453, 6840.555363901381, 6854.794356169323, 4917.58200552957, 4958.157113290749, 4970.0, 4980.477049909779, 4991.800327986913, 4925.13810083234, 4967.950320496749, 4973.328600638867, 5003.449620541737, 5019.899602008012, 5506.752196151103, 5510.91733623996, 5534.529564987021, 5565.499105080562, 5566.415526369673, 6332.968335158294, 6369.681515924185, 6421.0, 6428.5178611604315, 6432.839179020562, 1716.4249976257843, 1722.9483115506555, 1734.8525375342986, 1736.053850651398, 1742.668892910343, 1097.8572785537829, 1133.973753752855, 1193.7910865598485, 1205.6563879294358, 1220.4385982448173, 5473.236015811989, 5606.439356064361, 5629.4652008059165, 5660.179274005246, 5704.687921778014, 6420.390062944013, 6462.838429039311, 6496.902546461807, 6517.51118666102, 6519.380658837403, 5552.888942221214, 5657.575681823797, 5658.377578466366, 5661.264035675418, 5679.517241034476, 3398.4052790761516, 3446.603640581315, 3496.3706532824335, 3509.0, 3522.330757156132, 6301.842453938688, 6319.905201421982, 6365.458935990493, 6408.198975128109, 6429.1320671709655, 6565.244996825426, 6590.110335104795, 6599.713055954139, 6616.636085015371, 6776.593404395752, 6299.700609277672, 6319.842003949938, 6368.363163683594, 6373.195793850691, 6409.166808314889, 6599.5050371223315, 6618.801435956929, 6628.801135965929, 6657.267700553032, 6658.300878407697, 6408.0, 6455.67721613908, 6459.224893012869, 6609.438197753053, 6619.106420633153, 6342.904856427065, 6344.460720838781, 6366.607041141598, 6383.904241436289, 6384.521160912857, 4823.421189457287, 4871.272087630938, 4924.901501970012, 4928.359313289249, 4945.208766597327, 6494.967525162344, 6557.967210163919, 6603.141591593062, 6619.304972977768, 6658.600483970978, 6218.792328723238, 6340.207474065742, 6380.330065343072, 6390.936090639034, 6419.0, 6200.348963358782, 6305.8108256752375, 6306.558540902093, 6345.777897773556, 6428.260750013621, 6237.5009999200865, 6275.52933529978, 6277.466415354746, 6284.151639528788, 6351.2060992375955, 6385.808425747235, 6399.968000159969, 6411.903821442589, 6444.712127194778, 6484.870302593828, 5967.0, 6115.296740874856, 6209.19280493551, 6243.938530449744, 6282.371762823681], "value": 4948.650463764323, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [874.3748220022684, 910.7495438754341, 928.1971095002824, 934.3086116273955, 937.742120916748, 16191.271392787323, 16226.0, 16269.91865040676, 16288.592785180377, 18232.635347293046, 19521.51196220095, 20495.282665106723, 21100.0, 21308.36074917755, 21390.57218855622, 1022.6062965758199, 1037.9584816607326, 1042.8748550173989, 1044.7179261599401, 1046.2205656785704, 1053.1522124689623, 1053.5838343854211, 1063.6596289187464, 1065.7655315830505, 1066.6693325069214, 991.192178374626, 1045.2108657963227, 1095.6658219243127, 1105.6351404036689, 1115.314081839671, 1074.6507385099835, 1077.9245452818307, 1078.7087486378634, 1078.9784204315908, 1079.6976846482996, 790.324272746799, 792.9881051784228, 793.3573805217792, 794.4041968523608, 795.7214974758846, 17275.740863886927, 17451.5637109072, 17470.737938930924, 17504.299828006864, 19367.612647747108, 19203.903980480147, 19907.701384479245, 20034.1986320547, 20145.395638130878, 20284.863987896864, 15628.374865005386, 15967.281472333772, 15984.360625574964, 15998.0, 16001.119938403383, 3522.3483655523555, 3548.095235714902, 3550.627184145679, 3573.356795776759, 3575.1777091268896, 101695.0, 101868.0, 105787.47106264497, 105944.47027764888, 106609.0, 14956.252187390586, 15148.318325675371, 15181.924090379478, 15351.232438378036, 15495.767563486557, 23234.0, 28473.28816779597, 28597.714022859505, 28687.426251474855, 28752.281192970342, 8477.194666506672, 8635.093315201939, 8679.652813887375, 8703.564821758886, 8723.084076172037, 3949.624785645359, 4074.1444296698023, 4075.2460794753065, 4087.1825634873144, 4092.7544347339253, 4925.926111108336, 4968.975155124202, 5073.34046573943, 5093.2360145977655, 5119.820806271762, 925.5141050948306, 963.6241865672393, 971.9368241064308, 1050.238577031646, 1059.4914441068331, 681.6251061915926, 692.1071817355655, 696.1437431958719, 696.2376198063113, 705.0833915909298, 12988.025898057684, 13180.418349798085, 13416.463341466428, 14092.154470731788, 14097.154170749787, 674.6188403551978, 695.8364784275691, 713.390051505955, 713.9464540159508, 722.0324764815173, 5205.141151709925, 5217.947820521822, 5279.076161671692, 5332.413434522199, 5380.7086299287885, 93159.0, 93706.0, 97841.0, 102375.4881225589, 104381.0, 87201.0, 87500.5624971871, 87592.0, 87619.56190219008, 89176.0, 74796.0, 75083.99999999891, 78181.60909195417, 80016.59991700004, 80403.59798200971, 11325.0, 12382.442790074288, 12609.43257553394, 12729.936350318188, 12870.356482175666, 32917.01248962535, 33566.0, 35213.0, 35319.470207947415, 36265.637343627284, 58619.70690146522, 60360.0, 63870.68064659647, 64327.35672643214, 65562.67218663877, 17830.0, 19254.7111793326, 19282.517937051685, 19405.70891436658, 19633.901830490755, 20486.692699609815, 21119.894400527897, 21141.682874756585, 21153.57692846165, 21803.89098054563, 18644.813551864307, 18990.620187596447, 19198.8080119197, 19436.2225510978, 19636.018199089704, 18893.433197004113, 19436.805631943498, 19838.90080549588, 19873.503162421057, 20082.698759518327, 17294.033041405255, 17443.476695699148, 17857.910710446366, 18110.094495275447, 18374.35689750852, 13775.38010789497, 13808.516701915385, 13820.308984550531, 14017.579472615838, 14185.148891066568, 13790.379432925341, 14026.08830426019, 14138.635570838022, 14670.046446980912, 14679.192644404233], "value": 8927.220974984062, "unit": "score"}]}, {"extraOptions": ["e10s"], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1533.8000000000002, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [102.0, 106.0, 109.0, 108.0, 113.0, 111.0, 111.0, 108.0, 109.0, 108.0], "value": 108.5, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [148.0, 121.0, 156.0, 179.0, 123.0, 150.0, 149.0, 122.0, 169.0, 122.0], "value": 143.9, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [164.0, 166.0, 164.0, 164.0, 164.0, 162.0, 162.0, 169.0, 168.0, 164.0], "value": 164.7, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [76.0, 74.0, 77.0, 163.0, 75.0, 76.0, 74.0, 73.0, 95.0, 75.0], "value": 85.8, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [82.0, 81.0, 144.0, 83.0, 82.0, 81.0, 137.0, 82.0, 81.0, 128.0], "value": 98.1, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [115.0, 114.0, 114.0, 114.0, 114.0, 113.0, 113.0, 113.0, 114.0, 113.0], "value": 113.7, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [148.0, 149.0, 148.0, 149.0, 150.0, 152.0, 150.0, 150.0, 151.0, 149.0], "value": 149.6, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [94.0, 96.0, 94.0, 93.0, 94.0, 102.0, 95.0, 94.0, 95.0, 95.0], "value": 95.2, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [60.0, 56.0, 56.0, 55.0, 57.0, 57.0, 55.0, 59.0, 56.0, 60.0], "value": 57.1, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [53.0, 53.0, 54.0, 54.0, 57.0, 53.0, 54.0, 54.0, 56.0, 54.0], "value": 54.2, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [78.0, 80.0, 78.0, 78.0, 79.0, 77.0, 87.0, 78.0, 79.0, 80.0], "value": 79.4, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [126.0, 128.0, 129.0, 128.0, 127.0, 127.0, 127.0, 127.0, 126.0, 158.0], "value": 130.3, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [184.0, 189.0, 178.0, 203.0, 180.0, 177.0, 176.0, 184.0, 178.0, 182.0], "value": 183.1, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [70.0, 70.0, 69.0, 68.0, 77.0, 68.0, 73.0, 72.0, 68.0, 67.0], "value": 70.2, "unit": "score"}]}]} 04:32:30 INFO - Return code: 0 04:32:30 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 04:32:30 INFO - # TBPL SUCCESS # 04:32:30 INFO - Running post-action listener: _package_coverage_data 04:32:30 INFO - Running post-action listener: _resource_record_post_action 04:32:30 INFO - [mozharness: 2017-07-10 11:32:30.447942Z] Finished run-tests step (success) 04:32:30 INFO - Running post-run listener: _resource_record_post_run 04:32:30 INFO - Total resource usage - Wall time: 1195s; CPU: 13.0%; Read bytes: 4096; Write bytes: 435830784; Read time: 8; Write time: 368768 04:32:30 INFO - TinderboxPrint: CPU usage
13.1% 04:32:30 INFO - TinderboxPrint: I/O read bytes / time
4,096 / 8 04:32:30 INFO - TinderboxPrint: I/O write bytes / time
435,830,784 / 368,768 04:32:30 INFO - TinderboxPrint: CPU idle
8,279.6 (86.9%) 04:32:30 INFO - TinderboxPrint: CPU user
1,201.3 (12.6%) 04:32:30 INFO - TinderboxPrint: Swap in / out
0 / 0 04:32:30 INFO - install - Wall time: 18s; CPU: 13.0%; Read bytes: 0; Write bytes: 106827776; Read time: 0; Write time: 106692 04:32:30 INFO - setup-mitmproxy - Wall time: 0s; CPU: Can't collect data; Read bytes: 0; Write bytes: 0; Read time: 0; Write time: 0 04:32:30 INFO - run-tests - Wall time: 1177s; CPU: 13.0%; Read bytes: 0; Write bytes: 327880704; Read time: 0; Write time: 262036 04:32:31 INFO - Running post-run listener: _upload_blobber_files 04:32:31 INFO - Blob upload gear active. 04:32:31 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 04:32:31 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 04:32:31 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'] 04:32:31 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 04:32:34 INFO - (blobuploader) - INFO - Open directory for files ... 04:32:34 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 04:32:34 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 04:32:34 INFO - (blobuploader) - INFO - Uploading, attempt #1. 04:32:43 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 04:32:43 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 04:32:43 INFO - (blobuploader) - INFO - Done attempting. 04:32:43 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 04:32:43 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 04:32:43 INFO - (blobuploader) - INFO - Uploading, attempt #1. 04:32:49 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 04:32:49 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 04:32:49 INFO - (blobuploader) - INFO - Done attempting. 04:32:49 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 04:32:49 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 04:32:49 INFO - (blobuploader) - INFO - Uploading, attempt #1. 04:32:56 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 04:32:56 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 04:32:56 INFO - (blobuploader) - INFO - Done attempting. 04:32:56 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/perfherder-data.json ... 04:32:56 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 04:32:56 INFO - (blobuploader) - INFO - Uploading, attempt #1. 04:33:03 INFO - (blobuploader) - INFO - TinderboxPrint: perfherder-data.json: uploaded 04:33:03 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 04:33:03 INFO - (blobuploader) - INFO - Done attempting. 04:33:03 INFO - (blobuploader) - INFO - Iteration through files over. 04:33:03 INFO - Return code: 0 04:33:03 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 04:33:03 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 04:33:03 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/760a892ed417346443ba6c39e8ffaca198fece761c809a605816a6d10a9b13e91ffac8710774a71ad59c7fb377b8130467f2b78bc4ec44b2f12f90c4bfcb28e7", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/6754559fe1f1f1e90cce9db3cf4e9202d10d6e284180edc0e492782c6167f960c51e094d4afd48a0806fb36cc22b2c6df3904f1dd2aa048ca6dbae2b70b194bc", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/dd0368e5d425517265dda9cf5daca0b5af7fbadf7ffe902d9033e7b8577366ec91aafedb1d5c9d86cd9a7085e9f9b6eed07c721f111452752c5c1e1ef886204b", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/454afa735e9874e7b06aa463c752ef3e442a4f2c8d60099fbf2afa475fd569c8aaebaf70a352936a5611fbd4d9f334a3e1de32918f670ab6cd7964e2903bbabd"} 04:33:03 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 04:33:03 INFO - Writing to file /builds/slave/test/properties/blobber_files 04:33:03 INFO - Contents: 04:33:03 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/760a892ed417346443ba6c39e8ffaca198fece761c809a605816a6d10a9b13e91ffac8710774a71ad59c7fb377b8130467f2b78bc4ec44b2f12f90c4bfcb28e7", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/6754559fe1f1f1e90cce9db3cf4e9202d10d6e284180edc0e492782c6167f960c51e094d4afd48a0806fb36cc22b2c6df3904f1dd2aa048ca6dbae2b70b194bc", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/dd0368e5d425517265dda9cf5daca0b5af7fbadf7ffe902d9033e7b8577366ec91aafedb1d5c9d86cd9a7085e9f9b6eed07c721f111452752c5c1e1ef886204b", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/454afa735e9874e7b06aa463c752ef3e442a4f2c8d60099fbf2afa475fd569c8aaebaf70a352936a5611fbd4d9f334a3e1de32918f670ab6cd7964e2903bbabd"} 04:33:03 INFO - Running post-run listener: copy_logs_to_upload_dir 04:33:03 INFO - Copying logs to upload dir... 04:33:03 INFO - mkdir: /builds/slave/test/build/upload/logs 04:33:03 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1280.616560 ========= master_lag: 0.11 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 20 secs) (at 2017-07-10 04:33:03.322241) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-07-10 04:33:03.326657) ========= 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=3836458cccd887f2d2de3cf1000001de-1499671981.326684-287146855 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/760a892ed417346443ba6c39e8ffaca198fece761c809a605816a6d10a9b13e91ffac8710774a71ad59c7fb377b8130467f2b78bc4ec44b2f12f90c4bfcb28e7", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/6754559fe1f1f1e90cce9db3cf4e9202d10d6e284180edc0e492782c6167f960c51e094d4afd48a0806fb36cc22b2c6df3904f1dd2aa048ca6dbae2b70b194bc", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/dd0368e5d425517265dda9cf5daca0b5af7fbadf7ffe902d9033e7b8577366ec91aafedb1d5c9d86cd9a7085e9f9b6eed07c721f111452752c5c1e1ef886204b", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/454afa735e9874e7b06aa463c752ef3e442a4f2c8d60099fbf2afa475fd569c8aaebaf70a352936a5611fbd4d9f334a3e1de32918f670ab6cd7964e2903bbabd"} build_url:https://queue.taskcluster.net/v1/task/aA7Yn3CFSGWrt0-fZEf0Jw/artifacts/public/build/target.tar.bz2 program finished with exit code 0 elapsedTime=0.011313 build_url: 'https://queue.taskcluster.net/v1/task/aA7Yn3CFSGWrt0-fZEf0Jw/artifacts/public/build/target.tar.bz2' blobber_files: '{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/760a892ed417346443ba6c39e8ffaca198fece761c809a605816a6d10a9b13e91ffac8710774a71ad59c7fb377b8130467f2b78bc4ec44b2f12f90c4bfcb28e7", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/6754559fe1f1f1e90cce9db3cf4e9202d10d6e284180edc0e492782c6167f960c51e094d4afd48a0806fb36cc22b2c6df3904f1dd2aa048ca6dbae2b70b194bc", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/dd0368e5d425517265dda9cf5daca0b5af7fbadf7ffe902d9033e7b8577366ec91aafedb1d5c9d86cd9a7085e9f9b6eed07c721f111452752c5c1e1ef886204b", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/454afa735e9874e7b06aa463c752ef3e442a4f2c8d60099fbf2afa475fd569c8aaebaf70a352936a5611fbd4d9f334a3e1de32918f670ab6cd7964e2903bbabd"}' ========= master_lag: 0.24 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-07-10 04:33:03.574640) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-07-10 04:33:03.574986) ========= 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=3836458cccd887f2d2de3cf1000001de-1499671981.326684-287146855 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004522 ========= master_lag: 0.25 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-07-10 04:33:03.833716) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2017-07-10 04:33:03.834019) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2017-07-10 04:33:03.834318) ========= ========= Total master_lag: 0.67 =========