builder: mozilla-beta_ubuntu64_hw_test-dromaeojs-pgo slave: talos-linux64-ix-087 starttime: 1489509208.74 results: success (0) revision: a5807cd917b25038d8c00428ee42623e2f907c7e ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2017-03-14 09:33:28.745036) ========= master: http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2017-03-14 09:33:28.746150) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-03-14 09:33:28.746768) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-03-14 09:33:28.761710) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-03-14 09:33:28.762039) ========= 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=ca619d3d7d62c99d832f7b8a000001c4-1489509208.45274-2124180520 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2017-03-14 09:33:28-- 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% 229M=0s 2017-03-14 09:33:28 (229 MB/s) - `archiver_client.py' saved [12179/12179] program finished with exit code 0 elapsedTime=0.114966 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-03-14 09:33:28.894870) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-03-14 09:33:28.895585) ========= 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=ca619d3d7d62c99d832f7b8a000001c4-1489509208.45274-2124180520 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.020433 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-03-14 09:33:28.947781) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2017-03-14 09:33:28.948160) ========= bash -c 'python archiver_client.py mozharness --repo releases/mozilla-beta --rev a5807cd917b25038d8c00428ee42623e2f907c7e --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'python archiver_client.py mozharness --repo releases/mozilla-beta --rev a5807cd917b25038d8c00428ee42623e2f907c7e --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=ca619d3d7d62c99d832f7b8a000001c4-1489509208.45274-2124180520 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2017-03-14 09:33:28,972 truncating revision to first 12 chars 2017-03-14 09:33:28,972 Setting DEBUG logging. 2017-03-14 09:33:28,973 attempt 1/10 2017-03-14 09:33:28,973 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/releases/mozilla-beta/a5807cd917b2?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2017-03-14 09:33:29,798 unpacking tar archive at: mozilla-beta-a5807cd917b2/testing/mozharness/ program finished with exit code 0 elapsedTime=1.552493 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2017-03-14 09:33:30.515631) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-03-14 09:33:30.516013) ========= script_repo_revision: a5807cd917b25038d8c00428ee42623e2f907c7e ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-03-14 09:33:30.516491) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-03-14 09:33:30.516798) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-03-14 09:33:30.526635) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 34 secs) (at 2017-03-14 09:33:30.527065) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Mozilla-Beta --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Beta 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', '--add-option', '--webServer,localhost', '--branch-name', 'Mozilla-Beta', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Mozilla-Beta'] 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=ca619d3d7d62c99d832f7b8a000001c4-1489509208.45274-2124180520 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 09:33:30 INFO - MultiFileLogger online at 20170314 09:33:30 in /builds/slave/test 09:33:30 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Mozilla-Beta --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Beta 09:33:30 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 09:33:30 INFO - {'append_to_log': False, 09:33:30 INFO - 'base_work_dir': '/builds/slave/test', 09:33:30 INFO - 'blob_upload_branch': 'Mozilla-Beta', 09:33:30 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 09:33:30 INFO - 'branch': 'Mozilla-Beta', 09:33:30 INFO - 'buildbot_json_path': 'buildprops.json', 09:33:30 INFO - 'config_files': ('talos/linux_config.py',), 09:33:30 INFO - 'default_actions': ('clobber', 09:33:30 INFO - 'read-buildbot-config', 09:33:30 INFO - 'download-and-extract', 09:33:30 INFO - 'populate-webroot', 09:33:30 INFO - 'create-virtualenv', 09:33:30 INFO - 'install', 09:33:30 INFO - 'run-tests'), 09:33:30 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 09:33:30 INFO - 'download_minidump_stackwalk': True, 09:33:30 INFO - 'download_symbols': 'ondemand', 09:33:30 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 09:33:30 INFO - 'tooltool.py': '/tools/tooltool.py', 09:33:30 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 09:33:30 INFO - '/tools/misc-python/virtualenv.py')}, 09:33:30 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 09:33:30 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 09:33:30 INFO - 'installer_path': 'installer.exe', 09:33:30 INFO - 'log_level': 'info', 09:33:30 INFO - 'log_name': 'talos', 09:33:30 INFO - 'log_to_console': True, 09:33:30 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 09:33:30 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 09:33:30 INFO - 'opt_config_files': (), 09:33:30 INFO - 'pip_index': False, 09:33:30 INFO - 'sps_profile': False, 09:33:30 INFO - 'sps_profile_interval': 0, 09:33:30 INFO - 'suite': 'dromaeojs', 09:33:30 INFO - 'system_bits': '32', 09:33:30 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 09:33:30 INFO - 'title': 'talos-linux64-ix-087', 09:33:30 INFO - 'tooltool_cache': '/builds/tooltool_cache', 09:33:30 INFO - 'use_talos_json': True, 09:33:30 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 09:33:30 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 09:33:30 INFO - 'work_dir': 'build'} 09:33:30 INFO - [mozharness: 2017-03-14 16:33:30.653681Z] Running clobber step. 09:33:30 INFO - Running pre-action listener: _resource_record_pre_action 09:33:30 INFO - Running main action method: clobber 09:33:30 INFO - rmtree: /builds/slave/test/build 09:33:30 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 09:33:31 INFO - Running post-action listener: _resource_record_post_action 09:33:31 INFO - [mozharness: 2017-03-14 16:33:31.655361Z] Finished clobber step (success) 09:33:31 INFO - [mozharness: 2017-03-14 16:33:31.655463Z] Running read-buildbot-config step. 09:33:31 INFO - Running pre-action listener: _resource_record_pre_action 09:33:31 INFO - Running main action method: read_buildbot_config 09:33:31 INFO - Using buildbot properties: 09:33:31 INFO - { 09:33:31 INFO - "project": "", 09:33:31 INFO - "product": "firefox", 09:33:31 INFO - "who": "ffxbld@noreply.mozilla.org", 09:33:31 INFO - "installer_path": "public/build/target.tar.bz2", 09:33:31 INFO - "builddir": "mozilla-beta_ubuntu64_hw_test-dromaeojs", 09:33:31 INFO - "repository": "https://hg.mozilla.org/releases/mozilla-beta/", 09:33:31 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-beta pgo talos dromaeojs", 09:33:31 INFO - "stage_platform": "linux64-pgo", 09:33:31 INFO - "basedir": "/builds/slave/test", 09:33:31 INFO - "buildnumber": 43, 09:33:31 INFO - "platform": "ubuntu64_hw", 09:33:31 INFO - "master": "http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/", 09:33:31 INFO - "slavebuilddir": "test", 09:33:31 INFO - "taskId": "B2YtdqkNR0aIiBQDGQIguQ", 09:33:31 INFO - "branch": "mozilla-beta", 09:33:31 INFO - "script_repo_revision": "production", 09:33:31 INFO - "revision": "a5807cd917b25038d8c00428ee42623e2f907c7e", 09:33:31 INFO - "slavename": "talos-linux64-ix-087", 09:33:31 INFO - "repo_path": "releases/mozilla-beta" 09:33:31 INFO - } 09:33:31 INFO - Finding installer, test and symbols from parent task. 09:33:31 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/B2YtdqkNR0aIiBQDGQIguQ'}, attempt #1 09:33:32 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/B2YtdqkNR0aIiBQDGQIguQ'}, attempt #1 09:33:32 INFO - Task dependencies: SWlXTsUfQ3eVHfbMtpvdEg 09:33:32 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/SWlXTsUfQ3eVHfbMtpvdEg'}, attempt #1 09:33:33 INFO - Set installer_url: https://queue.taskcluster.net/v1/task/SWlXTsUfQ3eVHfbMtpvdEg/artifacts/public/build/target.tar.bz2 09:33:33 INFO - Set test_url: https://queue.taskcluster.net/v1/task/SWlXTsUfQ3eVHfbMtpvdEg/artifacts/public/build/test_packages.json 09:33:33 INFO - Set symbols_url: https://queue.taskcluster.net/v1/task/SWlXTsUfQ3eVHfbMtpvdEg/artifacts/public/build/target.crashreporter-symbols.zip 09:33:33 INFO - Running post-action listener: _resource_record_post_action 09:33:33 INFO - [mozharness: 2017-03-14 16:33:33.017717Z] Finished read-buildbot-config step (success) 09:33:33 INFO - [mozharness: 2017-03-14 16:33:33.017938Z] Running download-and-extract step. 09:33:33 INFO - Running pre-action listener: _resource_record_pre_action 09:33:33 INFO - Running main action method: download_and_extract 09:33:33 INFO - mkdir: /builds/slave/test/build/tests 09:33:33 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 09:33:33 INFO - trying https://queue.taskcluster.net/v1/task/SWlXTsUfQ3eVHfbMtpvdEg/artifacts/public/build/target.test_packages.json 09:33:33 INFO - Downloading https://queue.taskcluster.net/v1/task/SWlXTsUfQ3eVHfbMtpvdEg/artifacts/public/build/target.test_packages.json to /builds/slave/test/build/target.test_packages.json 09:33:33 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/SWlXTsUfQ3eVHfbMtpvdEg/artifacts/public/build/target.test_packages.json', 'file_name': '/builds/slave/test/build/target.test_packages.json'}, attempt #1 09:33:33 INFO - Downloaded 896 bytes. 09:33:33 INFO - Reading from file /builds/slave/test/build/target.test_packages.json 09:33:33 INFO - Using the following test package requirements: 09:33:33 INFO - {u'common': [u'target.common.tests.zip'], 09:33:33 INFO - u'cppunittest': [u'target.common.tests.zip', u'target.cppunittest.tests.zip'], 09:33:33 INFO - u'gtest': [u'target.common.tests.zip', u'target.gtest.tests.zip'], 09:33:33 INFO - u'jittest': [u'target.common.tests.zip', u'target.jsshell.zip'], 09:33:33 INFO - u'mochitest': [u'target.common.tests.zip', u'target.mochitest.tests.zip'], 09:33:33 INFO - u'mozbase': [u'target.common.tests.zip'], 09:33:33 INFO - u'reftest': [u'target.common.tests.zip', u'target.reftest.tests.zip'], 09:33:33 INFO - u'talos': [u'target.common.tests.zip', u'target.talos.tests.zip'], 09:33:33 INFO - u'web-platform': [u'target.common.tests.zip', 09:33:33 INFO - u'target.web-platform.tests.zip'], 09:33:33 INFO - u'xpcshell': [u'target.common.tests.zip', u'target.xpcshell.tests.zip']} 09:33:33 INFO - Downloading packages: [u'target.common.tests.zip'] for test suite category: common 09:33:33 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/SWlXTsUfQ3eVHfbMtpvdEg/artifacts/public/build/target.common.tests.zip 09:33:33 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/SWlXTsUfQ3eVHfbMtpvdEg/artifacts/public/build/target.common.tests.zip'}, attempt #1 09:33:33 INFO - Fetch https://queue.taskcluster.net/v1/task/SWlXTsUfQ3eVHfbMtpvdEg/artifacts/public/build/target.common.tests.zip into memory 09:33:34 INFO - Expected file size: 21864902 09:33:34 INFO - Obtained file size: 21864902 09:33:38 INFO - Downloading packages: [u'target.common.tests.zip', u'target.talos.tests.zip'] for test suite category: talos 09:33:38 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/SWlXTsUfQ3eVHfbMtpvdEg/artifacts/public/build/target.common.tests.zip 09:33:38 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/SWlXTsUfQ3eVHfbMtpvdEg/artifacts/public/build/target.common.tests.zip'}, attempt #1 09:33:38 INFO - Fetch https://queue.taskcluster.net/v1/task/SWlXTsUfQ3eVHfbMtpvdEg/artifacts/public/build/target.common.tests.zip into memory 09:33:39 INFO - Expected file size: 21864902 09:33:39 INFO - Obtained file size: 21864902 09:33:43 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/SWlXTsUfQ3eVHfbMtpvdEg/artifacts/public/build/target.talos.tests.zip 09:33:43 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/SWlXTsUfQ3eVHfbMtpvdEg/artifacts/public/build/target.talos.tests.zip'}, attempt #1 09:33:43 INFO - Fetch https://queue.taskcluster.net/v1/task/SWlXTsUfQ3eVHfbMtpvdEg/artifacts/public/build/target.talos.tests.zip into memory 09:33:44 INFO - Expected file size: 14403650 09:33:44 INFO - Obtained file size: 14403650 09:33:44 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 09:33:44 INFO - trying https://queue.taskcluster.net/v1/task/SWlXTsUfQ3eVHfbMtpvdEg/artifacts/public/build/target.tar.bz2 09:33:44 INFO - Downloading https://queue.taskcluster.net/v1/task/SWlXTsUfQ3eVHfbMtpvdEg/artifacts/public/build/target.tar.bz2 to /builds/slave/test/build/target.tar.bz2 09:33:44 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/SWlXTsUfQ3eVHfbMtpvdEg/artifacts/public/build/target.tar.bz2', 'file_name': '/builds/slave/test/build/target.tar.bz2'}, attempt #1 09:33:46 INFO - Downloaded 58858461 bytes. 09:33:46 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/SWlXTsUfQ3eVHfbMtpvdEg/artifacts/public/build/target.tar.bz2 09:33:46 INFO - mkdir: /builds/slave/test/properties 09:33:46 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 09:33:46 INFO - Writing to file /builds/slave/test/properties/build_url 09:33:46 INFO - Contents: 09:33:46 INFO - build_url:https://queue.taskcluster.net/v1/task/SWlXTsUfQ3eVHfbMtpvdEg/artifacts/public/build/target.tar.bz2 09:33:46 INFO - Running post-action listener: _resource_record_post_action 09:33:46 INFO - Running post-action listener: set_extra_try_arguments 09:33:46 INFO - [mozharness: 2017-03-14 16:33:46.004746Z] Finished download-and-extract step (success) 09:33:46 INFO - [mozharness: 2017-03-14 16:33:46.004883Z] Running populate-webroot step. 09:33:46 INFO - Running pre-action listener: _resource_record_pre_action 09:33:46 INFO - Running main action method: populate_webroot 09:33:46 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 09:33:46 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 09:33:46 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 09:33:46 INFO - '--tppagecycles', 09:33:46 INFO - '7'], 09:33:46 INFO - 'tests': ['tsvgm']}}, 09:33:46 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 09:33:46 INFO - 'tests': ['tresize', 'tcanvasmark']}, 09:33:46 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 09:33:46 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 09:33:46 INFO - 'tests': ['dromaeo_css', 'kraken']}, 09:33:46 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 09:33:46 INFO - 'g1': {'pagesets_name': 'tp5n.zip', 09:33:46 INFO - 'talos_options': ['--disable-e10s'], 09:33:46 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 09:33:46 INFO - 'g1-e10s': {'pagesets_name': 'tp5n.zip', 09:33:46 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 09:33:46 INFO - 'g2': {'pagesets_name': 'tp5n.zip', 09:33:46 INFO - 'talos_options': ['--disable-e10s'], 09:33:46 INFO - 'tests': ['damp', 'tps']}, 09:33:46 INFO - 'g2-e10s': {'pagesets_name': 'tp5n.zip', 09:33:46 INFO - 'tests': ['damp', 'tps']}, 09:33:46 INFO - 'g3': {'talos_options': ['--disable-e10s'], 09:33:46 INFO - 'tests': ['dromaeo_dom']}, 09:33:46 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 09:33:46 INFO - 'g4': {'talos_options': ['--disable-e10s'], 09:33:46 INFO - 'tests': ['basic_compositor_video']}, 09:33:46 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 09:33:46 INFO - 'other': {'talos_options': ['--disable-e10s'], 09:33:46 INFO - 'tests': ['a11yr', 09:33:46 INFO - 'ts_paint', 09:33:46 INFO - 'tpaint', 09:33:46 INFO - 'sessionrestore', 09:33:46 INFO - 'sessionrestore_no_auto_restore', 09:33:46 INFO - 'tabpaint']}, 09:33:46 INFO - 'other-e10s': {'tests': ['a11yr', 09:33:46 INFO - 'ts_paint', 09:33:46 INFO - 'tpaint', 09:33:46 INFO - 'sessionrestore', 09:33:46 INFO - 'sessionrestore_no_auto_restore', 09:33:46 INFO - 'tabpaint']}, 09:33:46 INFO - 'other-e10s_l64': {'tests': ['a11yr', 09:33:46 INFO - 'ts_paint', 09:33:46 INFO - 'tpaint', 09:33:46 INFO - 'sessionrestore', 09:33:46 INFO - 'sessionrestore_no_auto_restore', 09:33:46 INFO - 'tabpaint']}, 09:33:46 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 09:33:46 INFO - 'ts_paint', 09:33:46 INFO - 'tpaint', 09:33:46 INFO - 'sessionrestore', 09:33:46 INFO - 'sessionrestore_no_auto_restore', 09:33:46 INFO - 'tabpaint']}, 09:33:46 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 09:33:46 INFO - 'tests': ['a11yr', 09:33:46 INFO - 'ts_paint', 09:33:46 INFO - 'tpaint', 09:33:46 INFO - 'sessionrestore', 09:33:46 INFO - 'sessionrestore_no_auto_restore', 09:33:46 INFO - 'tabpaint']}, 09:33:46 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 09:33:46 INFO - 'tests': ['a11yr', 09:33:46 INFO - 'ts_paint', 09:33:46 INFO - 'tpaint', 09:33:46 INFO - 'sessionrestore', 09:33:46 INFO - 'sessionrestore_no_auto_restore', 09:33:46 INFO - 'tabpaint']}, 09:33:46 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 09:33:46 INFO - 'tests': ['tsvgx', 09:33:46 INFO - 'tsvgr_opacity', 09:33:46 INFO - 'tart', 09:33:46 INFO - 'tscrollx', 09:33:46 INFO - 'cart', 09:33:46 INFO - 'tsvg_static']}, 09:33:46 INFO - 'svgr-e10s': {'tests': ['tsvgx', 09:33:46 INFO - 'tsvgr_opacity', 09:33:46 INFO - 'tart', 09:33:46 INFO - 'tscrollx', 09:33:46 INFO - 'cart', 09:33:46 INFO - 'tsvg_static']}, 09:33:46 INFO - 'tp5o': {'pagesets_name': 'tp5n.zip', 09:33:46 INFO - 'talos_options': ['--disable-e10s'], 09:33:46 INFO - 'tests': ['tp5o']}, 09:33:46 INFO - 'tp5o-e10s': {'pagesets_name': 'tp5n.zip', 'tests': ['tp5o']}, 09:33:46 INFO - 'xperf': {'pagesets_name': 'tp5n.zip', 09:33:46 INFO - 'talos_options': ['--disable-e10s', 09:33:46 INFO - '--xperf_path', 09:33:46 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 09:33:46 INFO - 'tests': ['tp5n']}, 09:33:46 INFO - 'xperf-e10s': {'pagesets_name': 'tp5n.zip', 09:33:46 INFO - 'talos_options': ['--xperf_path', 09:33:46 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 09:33:46 INFO - 'tests': ['tp5n']}}, 09:33:46 INFO - 'talos.zip': {'path': '', 09:33:46 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 09:33:46 INFO - Running post-action listener: _resource_record_post_action 09:33:46 INFO - [mozharness: 2017-03-14 16:33:46.019553Z] Finished populate-webroot step (success) 09:33:46 INFO - [mozharness: 2017-03-14 16:33:46.019651Z] Running create-virtualenv step. 09:33:46 INFO - Running pre-action listener: _resource_record_pre_action 09:33:46 INFO - Running main action method: create_virtualenv 09:33:46 INFO - Creating virtualenv /builds/slave/test/build/venv 09:33:46 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 09:33:46 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 09:33:46 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 09:33:46 INFO - Using real prefix '/usr' 09:33:46 INFO - New python executable in /builds/slave/test/build/venv/bin/python 09:33:46 INFO - Installing distribute.............................................................................................................................................................................................done. 09:33:48 INFO - Installing pip.................done. 09:33:48 INFO - Return code: 0 09:33:48 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', '--version'] 09:33:48 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip --version 09:33:48 INFO - Reading from file tmpfile_stdout 09:33:48 INFO - Output received: 09:33:48 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) 09:33:48 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 09:33:48 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 09:33:48 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:33:48 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:33:48 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 09:33:48 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:33:48 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:33:48 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.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 0x16e51f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x17f5a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1a57630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1ae0850>, '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 0x1a556d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1a55b60>, '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': 'ca619d3d7d62c99d832f7b8a000001c4-1489509208.45274-2124180520', '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 09:33:48 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 09:33:48 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub pip>=1.5 09:33:48 INFO - Using env: {'DISPLAY': ':0', 09:33:48 INFO - 'HOME': '/home/cltbld', 09:33:48 INFO - 'LANG': 'en_US.UTF-8', 09:33:48 INFO - 'LANGUAGE': 'en_US:en', 09:33:48 INFO - 'LOGNAME': 'cltbld', 09:33:48 INFO - 'MAIL': '/var/mail/cltbld', 09:33:48 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:33:48 INFO - 'MOZ_NO_REMOTE': '1', 09:33:48 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:33:48 INFO - 'NO_EM_RESTART': '1', 09:33:48 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:33:48 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:33:48 INFO - 'PWD': '/builds/slave/test', 09:33:48 INFO - 'SHELL': '/bin/bash', 09:33:48 INFO - 'SHLVL': '1', 09:33:48 INFO - 'TERM': 'linux', 09:33:48 INFO - 'TMOUT': '86400', 09:33:48 INFO - 'USER': 'cltbld', 09:33:48 INFO - 'XDG_SESSION_COOKIE': 'ca619d3d7d62c99d832f7b8a000001c4-1489509208.45274-2124180520', 09:33:48 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:33:48 INFO - '_': '/tools/buildbot/bin/python'} 09:33:48 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:33:48 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 09:33:48 INFO - Cleaning up... 09:33:49 INFO - Return code: 0 09:33:49 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 09:33:49 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 09:33:49 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:33:49 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:33:49 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 09:33:49 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:33:49 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:33:49 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.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 0x16e51f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x17f5a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1a57630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1ae0850>, '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 0x1a556d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1a55b60>, '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': 'ca619d3d7d62c99d832f7b8a000001c4-1489509208.45274-2124180520', '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 09:33:49 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 09:33:49 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=3.1.1 09:33:49 INFO - Using env: {'DISPLAY': ':0', 09:33:49 INFO - 'HOME': '/home/cltbld', 09:33:49 INFO - 'LANG': 'en_US.UTF-8', 09:33:49 INFO - 'LANGUAGE': 'en_US:en', 09:33:49 INFO - 'LOGNAME': 'cltbld', 09:33:49 INFO - 'MAIL': '/var/mail/cltbld', 09:33:49 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:33:49 INFO - 'MOZ_NO_REMOTE': '1', 09:33:49 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:33:49 INFO - 'NO_EM_RESTART': '1', 09:33:49 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:33:49 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:33:49 INFO - 'PWD': '/builds/slave/test', 09:33:49 INFO - 'SHELL': '/bin/bash', 09:33:49 INFO - 'SHLVL': '1', 09:33:49 INFO - 'TERM': 'linux', 09:33:49 INFO - 'TMOUT': '86400', 09:33:49 INFO - 'USER': 'cltbld', 09:33:49 INFO - 'XDG_SESSION_COOKIE': 'ca619d3d7d62c99d832f7b8a000001c4-1489509208.45274-2124180520', 09:33:49 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:33:49 INFO - '_': '/tools/buildbot/bin/python'} 09:33:49 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:33:49 INFO - Downloading/unpacking psutil>=3.1.1 09:33:49 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 09:33:49 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 09:33:49 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 09:33:49 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 09:33:49 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 09:33:49 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 09:33:51 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 09:33:51 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 09:33:51 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 09:33:51 INFO - Installing collected packages: psutil 09:33:51 INFO - Running setup.py install for psutil 09:33:51 INFO - building 'psutil._psutil_linux' extension 09:33:51 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 09:33:51 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 09:33:51 INFO - building 'psutil._psutil_posix' extension 09:33:51 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 09:33:51 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 09:33:51 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 09:33:51 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 09:33:51 INFO - Successfully installed psutil 09:33:51 INFO - Cleaning up... 09:33:51 INFO - Return code: 0 09:33:51 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 09:33:51 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 09:33:51 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:33:51 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:33:51 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 09:33:51 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:33:51 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:33:51 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.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 0x16e51f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x17f5a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1a57630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1ae0850>, '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 0x1a556d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1a55b60>, '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': 'ca619d3d7d62c99d832f7b8a000001c4-1489509208.45274-2124180520', '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 09:33:51 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 09:33:51 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.3 09:33:51 INFO - Using env: {'DISPLAY': ':0', 09:33:51 INFO - 'HOME': '/home/cltbld', 09:33:51 INFO - 'LANG': 'en_US.UTF-8', 09:33:51 INFO - 'LANGUAGE': 'en_US:en', 09:33:51 INFO - 'LOGNAME': 'cltbld', 09:33:51 INFO - 'MAIL': '/var/mail/cltbld', 09:33:51 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:33:51 INFO - 'MOZ_NO_REMOTE': '1', 09:33:51 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:33:51 INFO - 'NO_EM_RESTART': '1', 09:33:51 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:33:51 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:33:51 INFO - 'PWD': '/builds/slave/test', 09:33:51 INFO - 'SHELL': '/bin/bash', 09:33:51 INFO - 'SHLVL': '1', 09:33:51 INFO - 'TERM': 'linux', 09:33:51 INFO - 'TMOUT': '86400', 09:33:51 INFO - 'USER': 'cltbld', 09:33:51 INFO - 'XDG_SESSION_COOKIE': 'ca619d3d7d62c99d832f7b8a000001c4-1489509208.45274-2124180520', 09:33:51 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:33:51 INFO - '_': '/tools/buildbot/bin/python'} 09:33:52 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:33:52 INFO - Downloading/unpacking mozsystemmonitor==0.3 09:33:52 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 09:33:52 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 09:33:52 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 09:33:52 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 09:33:52 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 09:33:52 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 09:33:54 INFO - Downloading mozsystemmonitor-0.3.tar.gz 09:33:54 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 09:33:54 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 09:33:54 INFO - Installing collected packages: mozsystemmonitor 09:33:54 INFO - Running setup.py install for mozsystemmonitor 09:33:54 INFO - Successfully installed mozsystemmonitor 09:33:54 INFO - Cleaning up... 09:33:54 INFO - Return code: 0 09:33:54 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 09:33:54 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 09:33:54 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:33:54 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:33:54 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 09:33:54 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:33:54 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:33:54 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.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 0x16e51f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x17f5a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1a57630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1ae0850>, '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 0x1a556d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1a55b60>, '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': 'ca619d3d7d62c99d832f7b8a000001c4-1489509208.45274-2124180520', '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 09:33:54 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 09:33:54 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema==2.5.1 09:33:54 INFO - Using env: {'DISPLAY': ':0', 09:33:54 INFO - 'HOME': '/home/cltbld', 09:33:54 INFO - 'LANG': 'en_US.UTF-8', 09:33:54 INFO - 'LANGUAGE': 'en_US:en', 09:33:54 INFO - 'LOGNAME': 'cltbld', 09:33:54 INFO - 'MAIL': '/var/mail/cltbld', 09:33:54 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:33:54 INFO - 'MOZ_NO_REMOTE': '1', 09:33:54 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:33:54 INFO - 'NO_EM_RESTART': '1', 09:33:54 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:33:54 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:33:54 INFO - 'PWD': '/builds/slave/test', 09:33:54 INFO - 'SHELL': '/bin/bash', 09:33:54 INFO - 'SHLVL': '1', 09:33:54 INFO - 'TERM': 'linux', 09:33:54 INFO - 'TMOUT': '86400', 09:33:54 INFO - 'USER': 'cltbld', 09:33:54 INFO - 'XDG_SESSION_COOKIE': 'ca619d3d7d62c99d832f7b8a000001c4-1489509208.45274-2124180520', 09:33:54 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:33:54 INFO - '_': '/tools/buildbot/bin/python'} 09:33:54 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:33:54 INFO - Downloading/unpacking jsonschema==2.5.1 09:33:54 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 09:33:54 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 09:33:54 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 09:33:54 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 09:33:54 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 09:33:54 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 09:33:56 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 09:33:56 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 09:33:56 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 09:33:56 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 09:33:56 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 09:33:56 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 09:33:56 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 09:33:56 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 09:33:56 INFO - Downloading functools32-3.2.3-2.tar.gz 09:33:56 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 09:33:56 INFO - warning: no files found matching '*.txt' 09:33:56 INFO - no previously-included directories found matching 'build' 09:33:56 INFO - no previously-included directories found matching 'dist' 09:33:56 INFO - no previously-included directories found matching '.git*' 09:33:56 INFO - Installing collected packages: jsonschema, functools32 09:33:56 INFO - Running setup.py install for functools32 09:33:56 INFO - warning: no files found matching '*.txt' 09:33:56 INFO - no previously-included directories found matching 'build' 09:33:56 INFO - no previously-included directories found matching 'dist' 09:33:56 INFO - no previously-included directories found matching '.git*' 09:33:57 INFO - Successfully installed jsonschema functools32 09:33:57 INFO - Cleaning up... 09:33:57 INFO - Return code: 0 09:33:57 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 09:33:57 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 09:33:57 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:33:57 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:33:57 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 09:33:57 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:33:57 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:33:57 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.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 0x16e51f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x17f5a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1a57630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1ae0850>, '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 0x1a556d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1a55b60>, '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': 'ca619d3d7d62c99d832f7b8a000001c4-1489509208.45274-2124180520', '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 09:33:57 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 09:33:57 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub functools32==3.2.3-2 09:33:57 INFO - Using env: {'DISPLAY': ':0', 09:33:57 INFO - 'HOME': '/home/cltbld', 09:33:57 INFO - 'LANG': 'en_US.UTF-8', 09:33:57 INFO - 'LANGUAGE': 'en_US:en', 09:33:57 INFO - 'LOGNAME': 'cltbld', 09:33:57 INFO - 'MAIL': '/var/mail/cltbld', 09:33:57 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:33:57 INFO - 'MOZ_NO_REMOTE': '1', 09:33:57 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:33:57 INFO - 'NO_EM_RESTART': '1', 09:33:57 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:33:57 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:33:57 INFO - 'PWD': '/builds/slave/test', 09:33:57 INFO - 'SHELL': '/bin/bash', 09:33:57 INFO - 'SHLVL': '1', 09:33:57 INFO - 'TERM': 'linux', 09:33:57 INFO - 'TMOUT': '86400', 09:33:57 INFO - 'USER': 'cltbld', 09:33:57 INFO - 'XDG_SESSION_COOKIE': 'ca619d3d7d62c99d832f7b8a000001c4-1489509208.45274-2124180520', 09:33:57 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:33:57 INFO - '_': '/tools/buildbot/bin/python'} 09:33:57 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:33:57 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 09:33:57 INFO - Cleaning up... 09:33:57 INFO - Return code: 0 09:33:57 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 09:33:57 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 09:33:57 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:33:57 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:33:57 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 09:33:57 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:33:57 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:33:57 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.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 0x16e51f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x17f5a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1a57630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1ae0850>, '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 0x1a556d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1a55b60>, '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': 'ca619d3d7d62c99d832f7b8a000001c4-1489509208.45274-2124180520', '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 09:33:57 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 09:33:57 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 09:33:57 INFO - Using env: {'DISPLAY': ':0', 09:33:57 INFO - 'HOME': '/home/cltbld', 09:33:57 INFO - 'LANG': 'en_US.UTF-8', 09:33:57 INFO - 'LANGUAGE': 'en_US:en', 09:33:57 INFO - 'LOGNAME': 'cltbld', 09:33:57 INFO - 'MAIL': '/var/mail/cltbld', 09:33:57 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:33:57 INFO - 'MOZ_NO_REMOTE': '1', 09:33:57 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:33:57 INFO - 'NO_EM_RESTART': '1', 09:33:57 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:33:57 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:33:57 INFO - 'PWD': '/builds/slave/test', 09:33:57 INFO - 'SHELL': '/bin/bash', 09:33:57 INFO - 'SHLVL': '1', 09:33:57 INFO - 'TERM': 'linux', 09:33:57 INFO - 'TMOUT': '86400', 09:33:57 INFO - 'USER': 'cltbld', 09:33:57 INFO - 'XDG_SESSION_COOKIE': 'ca619d3d7d62c99d832f7b8a000001c4-1489509208.45274-2124180520', 09:33:57 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:33:57 INFO - '_': '/tools/buildbot/bin/python'} 09:33:57 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:33:57 INFO - Downloading/unpacking blobuploader==1.2.4 09:33:57 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 09:33:57 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 09:33:57 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 09:33:57 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 09:33:57 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 09:33:57 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 09:33:59 INFO - Downloading blobuploader-1.2.4.tar.gz 09:33:59 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 09:33:59 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 09:33:59 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 09:33:59 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 09:33:59 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 09:33:59 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 09:33:59 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 09:33:59 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 09:33:59 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 09:34:00 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 09:34:00 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 09:34:00 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 09:34:00 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 09:34:00 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 09:34:00 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 09:34:00 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 09:34:00 INFO - Downloading docopt-0.6.1.tar.gz 09:34:00 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 09:34:00 INFO - Installing collected packages: blobuploader, requests, docopt 09:34:00 INFO - Running setup.py install for blobuploader 09:34:00 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 09:34:00 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 09:34:00 INFO - Running setup.py install for requests 09:34:00 INFO - Running setup.py install for docopt 09:34:00 INFO - Successfully installed blobuploader requests docopt 09:34:00 INFO - Cleaning up... 09:34:00 INFO - Return code: 0 09:34:00 INFO - Installing None into virtualenv /builds/slave/test/build/venv 09:34:00 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 09:34:00 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:34:00 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:34:00 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 09:34:00 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:34:00 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:34:00 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.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 0x16e51f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x17f5a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1a57630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1ae0850>, '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 0x1a556d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1a55b60>, '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': 'ca619d3d7d62c99d832f7b8a000001c4-1489509208.45274-2124180520', '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 09:34:00 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.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 09:34:00 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.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 09:34:00 INFO - Using env: {'DISPLAY': ':0', 09:34:00 INFO - 'HOME': '/home/cltbld', 09:34:00 INFO - 'LANG': 'en_US.UTF-8', 09:34:00 INFO - 'LANGUAGE': 'en_US:en', 09:34:00 INFO - 'LOGNAME': 'cltbld', 09:34:00 INFO - 'MAIL': '/var/mail/cltbld', 09:34:00 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:34:00 INFO - 'MOZ_NO_REMOTE': '1', 09:34:00 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:34:00 INFO - 'NO_EM_RESTART': '1', 09:34:00 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:34:00 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:34:00 INFO - 'PWD': '/builds/slave/test', 09:34:00 INFO - 'SHELL': '/bin/bash', 09:34:00 INFO - 'SHLVL': '1', 09:34:00 INFO - 'TERM': 'linux', 09:34:00 INFO - 'TMOUT': '86400', 09:34:00 INFO - 'USER': 'cltbld', 09:34:00 INFO - 'XDG_SESSION_COOKIE': 'ca619d3d7d62c99d832f7b8a000001c4-1489509208.45274-2124180520', 09:34:00 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:34:00 INFO - '_': '/tools/buildbot/bin/python'} 09:34:01 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:34:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 09:34:01 INFO - Running setup.py (path:/tmp/pip-QVBL39-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 09:34:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 09:34:01 INFO - Running setup.py (path:/tmp/pip-siFUyS-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 09:34:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 09:34:01 INFO - Running setup.py (path:/tmp/pip-3QUA57-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 09:34:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 09:34:01 INFO - Running setup.py (path:/tmp/pip-GkHZlT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 09:34:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 09:34:01 INFO - Running setup.py (path:/tmp/pip-9fIOF1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 09:34:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 09:34:01 INFO - Running setup.py (path:/tmp/pip-r6nlT2-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 09:34:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 09:34:01 INFO - Running setup.py (path:/tmp/pip-rMl3Vg-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 09:34:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 09:34:01 INFO - Running setup.py (path:/tmp/pip-TIAtrN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 09:34:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 09:34:01 INFO - Running setup.py (path:/tmp/pip-if92B3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 09:34:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 09:34:01 INFO - Running setup.py (path:/tmp/pip-afgldo-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 09:34:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 09:34:01 INFO - Running setup.py (path:/tmp/pip-tlbNeP-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 09:34:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 09:34:01 INFO - Running setup.py (path:/tmp/pip-Bmd_Hh-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 09:34:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 09:34:02 INFO - Running setup.py (path:/tmp/pip-DwIu33-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 09:34:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 09:34:02 INFO - Running setup.py (path:/tmp/pip-33u2_i-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 09:34:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 09:34:02 INFO - Running setup.py (path:/tmp/pip-Gkt9dQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 09:34:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 09:34:02 INFO - Running setup.py (path:/tmp/pip-YKmLlk-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 09:34:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 09:34:02 INFO - Running setup.py (path:/tmp/pip-TJuOwp-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 09:34:02 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 09:34:02 INFO - Running setup.py install for manifestparser 09:34:02 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 09:34:02 INFO - Running setup.py install for mozcrash 09:34:02 INFO - Running setup.py install for mozdebug 09:34:02 INFO - Running setup.py install for mozdevice 09:34:02 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 09:34:02 INFO - Installing dm script to /builds/slave/test/build/venv/bin 09:34:02 INFO - Running setup.py install for mozfile 09:34:02 INFO - Running setup.py install for mozhttpd 09:34:03 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 09:34:03 INFO - Running setup.py install for mozinfo 09:34:03 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 09:34:03 INFO - Running setup.py install for mozInstall 09:34:03 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 09:34:03 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 09:34:03 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 09:34:03 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 09:34:03 INFO - Running setup.py install for mozleak 09:34:03 INFO - Running setup.py install for mozlog 09:34:03 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 09:34:03 INFO - Running setup.py install for moznetwork 09:34:03 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 09:34:03 INFO - Running setup.py install for mozprocess 09:34:03 INFO - Running setup.py install for mozprofile 09:34:03 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 09:34:03 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 09:34:03 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 09:34:03 INFO - Running setup.py install for mozrunner 09:34:03 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 09:34:03 INFO - Running setup.py install for mozscreenshot 09:34:03 INFO - Running setup.py install for moztest 09:34:04 INFO - Running setup.py install for mozversion 09:34:04 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 09:34:04 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 09:34:04 INFO - Cleaning up... 09:34:04 INFO - Return code: 0 09:34:04 INFO - Installing None into virtualenv /builds/slave/test/build/venv 09:34:04 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 09:34:04 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:34:04 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:34:04 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 09:34:04 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:34:04 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:34:04 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.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 0x16e51f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x17f5a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1a57630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1ae0850>, '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 0x1a556d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1a55b60>, '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': 'ca619d3d7d62c99d832f7b8a000001c4-1489509208.45274-2124180520', '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 09:34:04 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.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 09:34:04 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.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 09:34:04 INFO - Using env: {'DISPLAY': ':0', 09:34:04 INFO - 'HOME': '/home/cltbld', 09:34:04 INFO - 'LANG': 'en_US.UTF-8', 09:34:04 INFO - 'LANGUAGE': 'en_US:en', 09:34:04 INFO - 'LOGNAME': 'cltbld', 09:34:04 INFO - 'MAIL': '/var/mail/cltbld', 09:34:04 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:34:04 INFO - 'MOZ_NO_REMOTE': '1', 09:34:04 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:34:04 INFO - 'NO_EM_RESTART': '1', 09:34:04 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:34:04 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:34:04 INFO - 'PWD': '/builds/slave/test', 09:34:04 INFO - 'SHELL': '/bin/bash', 09:34:04 INFO - 'SHLVL': '1', 09:34:04 INFO - 'TERM': 'linux', 09:34:04 INFO - 'TMOUT': '86400', 09:34:04 INFO - 'USER': 'cltbld', 09:34:04 INFO - 'XDG_SESSION_COOKIE': 'ca619d3d7d62c99d832f7b8a000001c4-1489509208.45274-2124180520', 09:34:04 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:34:04 INFO - '_': '/tools/buildbot/bin/python'} 09:34:04 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:34:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 09:34:04 INFO - Running setup.py (path:/tmp/pip-RBw8gS-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 09:34:04 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)) 09:34:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 09:34:04 INFO - Running setup.py (path:/tmp/pip-YHsSN2-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 09:34:04 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)) 09:34:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 09:34:04 INFO - Running setup.py (path:/tmp/pip-YhkiKY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 09:34:04 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)) 09:34:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 09:34:04 INFO - Running setup.py (path:/tmp/pip-Xc9FMf-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 09:34:04 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.49 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)) 09:34:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 09:34:04 INFO - Running setup.py (path:/tmp/pip-pc44FW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 09:34:04 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)) 09:34:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 09:34:04 INFO - Running setup.py (path:/tmp/pip-rbHWyS-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 09:34:04 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)) 09:34:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 09:34:04 INFO - Running setup.py (path:/tmp/pip-uJ_BWV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 09:34:04 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo==0.9 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)) 09:34:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 09:34:04 INFO - Running setup.py (path:/tmp/pip-e8kHi1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 09:34:05 INFO - Requirement already satisfied (use --upgrade to upgrade): mozInstall==1.12 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)) 09:34:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 09:34:05 INFO - Running setup.py (path:/tmp/pip-hKZDmP-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 09:34:05 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)) 09:34:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 09:34:05 INFO - Running setup.py (path:/tmp/pip-zo9UBn-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 09:34:05 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.4 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)) 09:34:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 09:34:05 INFO - Running setup.py (path:/tmp/pip-JHzj5I-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 09:34:05 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)) 09:34:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 09:34:05 INFO - Running setup.py (path:/tmp/pip-PkmIrh-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 09:34:05 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.24 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)) 09:34:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 09:34:05 INFO - Running setup.py (path:/tmp/pip-mdPwCn-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 09:34:05 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)) 09:34:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 09:34:05 INFO - Running setup.py (path:/tmp/pip-xSBV_W-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 09:34:05 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)) 09:34:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 09:34:05 INFO - Running setup.py (path:/tmp/pip-eIVcvU-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 09:34:05 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)) 09:34:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 09:34:05 INFO - Running setup.py (path:/tmp/pip-FwbhhL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 09:34:05 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)) 09:34:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 09:34:05 INFO - Running setup.py (path:/tmp/pip-AyXJgR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 09:34:05 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)) 09:34:05 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)) 09:34:05 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)) 09:34:05 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)) 09:34:05 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.49->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 09:34:05 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.49->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 09:34:05 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.4->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 09:34:05 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 09:34:05 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 09:34:05 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 09:34:05 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 09:34:05 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 09:34:05 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 09:34:07 INFO - Downloading blessings-1.6.tar.gz 09:34:07 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 09:34:07 INFO - Installing collected packages: blessings 09:34:07 INFO - Running setup.py install for blessings 09:34:07 INFO - Successfully installed blessings 09:34:07 INFO - Cleaning up... 09:34:07 INFO - Return code: 0 09:34:07 INFO - Done creating virtualenv /builds/slave/test/build/venv. 09:34:07 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 09:34:07 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 09:34:08 INFO - Reading from file tmpfile_stdout 09:34:08 INFO - Current package versions: 09:34:08 INFO - argparse == 1.2.1 09:34:08 INFO - blessings == 1.6 09:34:08 INFO - blobuploader == 1.2.4 09:34:08 INFO - docopt == 0.6.1 09:34:08 INFO - functools32 == 3.2.3-2 09:34:08 INFO - jsonschema == 2.5.1 09:34:08 INFO - manifestparser == 1.1 09:34:08 INFO - mozInstall == 1.12 09:34:08 INFO - mozcrash == 1.0 09:34:08 INFO - mozdebug == 0.1 09:34:08 INFO - mozdevice == 0.49 09:34:08 INFO - mozfile == 1.2 09:34:08 INFO - mozhttpd == 0.7 09:34:08 INFO - mozinfo == 0.9 09:34:08 INFO - mozleak == 0.1 09:34:08 INFO - mozlog == 3.4 09:34:08 INFO - moznetwork == 0.27 09:34:08 INFO - mozprocess == 0.24 09:34:08 INFO - mozprofile == 0.28 09:34:08 INFO - mozrunner == 6.13 09:34:08 INFO - mozscreenshot == 0.1 09:34:08 INFO - mozsystemmonitor == 0.3 09:34:08 INFO - moztest == 0.8 09:34:08 INFO - mozversion == 1.4 09:34:08 INFO - psutil == 3.1.1 09:34:08 INFO - requests == 1.2.3 09:34:08 INFO - wsgiref == 0.1.2 09:34:08 INFO - Installing None into virtualenv /builds/slave/test/build/venv 09:34:08 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 09:34:08 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:34:08 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:34:08 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 09:34:08 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:34:08 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:34:08 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.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 0x16e51f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x17f5a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1a57630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1ae0850>, '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 0x1a556d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1a55b60>, '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': 'ca619d3d7d62c99d832f7b8a000001c4-1489509208.45274-2124180520', '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 09:34:08 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.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 09:34:08 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.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 09:34:08 INFO - Using env: {'DISPLAY': ':0', 09:34:08 INFO - 'HOME': '/home/cltbld', 09:34:08 INFO - 'LANG': 'en_US.UTF-8', 09:34:08 INFO - 'LANGUAGE': 'en_US:en', 09:34:08 INFO - 'LOGNAME': 'cltbld', 09:34:08 INFO - 'MAIL': '/var/mail/cltbld', 09:34:08 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:34:08 INFO - 'MOZ_NO_REMOTE': '1', 09:34:08 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:34:08 INFO - 'NO_EM_RESTART': '1', 09:34:08 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:34:08 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:34:08 INFO - 'PWD': '/builds/slave/test', 09:34:08 INFO - 'SHELL': '/bin/bash', 09:34:08 INFO - 'SHLVL': '1', 09:34:08 INFO - 'TERM': 'linux', 09:34:08 INFO - 'TMOUT': '86400', 09:34:08 INFO - 'USER': 'cltbld', 09:34:08 INFO - 'XDG_SESSION_COOKIE': 'ca619d3d7d62c99d832f7b8a000001c4-1489509208.45274-2124180520', 09:34:08 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:34:08 INFO - '_': '/tools/buildbot/bin/python'} 09:34:08 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:34:08 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)) 09:34:08 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)) 09:34:08 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)) 09:34:08 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)) 09:34:08 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)) 09:34:08 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)) 09:34:08 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)) 09:34:08 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)) 09:34:08 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)) 09:34:08 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)) 09:34:08 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)) 09:34:08 INFO - Cleaning up... 09:34:08 INFO - Return code: 0 09:34:08 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 09:34:08 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 09:34:08 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:34:08 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:34:08 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 09:34:08 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:34:08 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:34:08 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.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 0x16e51f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x17f5a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1a57630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1ae0850>, '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 0x1a556d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1a55b60>, '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': 'ca619d3d7d62c99d832f7b8a000001c4-1489509208.45274-2124180520', '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 09:34:08 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema'] in /builds/slave/test/build 09:34:08 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema 09:34:08 INFO - Using env: {'DISPLAY': ':0', 09:34:08 INFO - 'HOME': '/home/cltbld', 09:34:08 INFO - 'LANG': 'en_US.UTF-8', 09:34:08 INFO - 'LANGUAGE': 'en_US:en', 09:34:08 INFO - 'LOGNAME': 'cltbld', 09:34:08 INFO - 'MAIL': '/var/mail/cltbld', 09:34:08 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:34:08 INFO - 'MOZ_NO_REMOTE': '1', 09:34:08 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:34:08 INFO - 'NO_EM_RESTART': '1', 09:34:08 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:34:08 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:34:08 INFO - 'PWD': '/builds/slave/test', 09:34:08 INFO - 'SHELL': '/bin/bash', 09:34:08 INFO - 'SHLVL': '1', 09:34:08 INFO - 'TERM': 'linux', 09:34:08 INFO - 'TMOUT': '86400', 09:34:08 INFO - 'USER': 'cltbld', 09:34:08 INFO - 'XDG_SESSION_COOKIE': 'ca619d3d7d62c99d832f7b8a000001c4-1489509208.45274-2124180520', 09:34:08 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:34:08 INFO - '_': '/tools/buildbot/bin/python'} 09:34:08 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:34:08 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 09:34:08 INFO - Cleaning up... 09:34:08 INFO - Return code: 0 09:34:08 INFO - Running post-action listener: _resource_record_post_action 09:34:08 INFO - Running post-action listener: _start_resource_monitoring 09:34:08 INFO - Starting resource monitoring. 09:34:08 INFO - [mozharness: 2017-03-14 16:34:08.657027Z] Finished create-virtualenv step (success) 09:34:08 INFO - [mozharness: 2017-03-14 16:34:08.657591Z] Running install step. 09:34:08 INFO - Running pre-action listener: _resource_record_pre_action 09:34:08 INFO - Running main action method: install 09:34:08 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 09:34:08 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 09:34:08 INFO - Reading from file tmpfile_stdout 09:34:08 INFO - Detecting whether we're running mozinstall >=1.0... 09:34:08 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 09:34:08 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 09:34:08 INFO - Reading from file tmpfile_stdout 09:34:08 INFO - Output received: 09:34:08 INFO - Usage: mozinstall [options] installer 09:34:08 INFO - Options: 09:34:08 INFO - -h, --help show this help message and exit 09:34:08 INFO - -d DEST, --destination=DEST 09:34:08 INFO - Directory to install application into. [default: 09:34:08 INFO - "/builds/slave/test"] 09:34:08 INFO - --app=APP Application being installed. [default: firefox] 09:34:08 INFO - mkdir: /builds/slave/test/build/application 09:34:08 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'] 09:34:08 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/target.tar.bz2 --destination /builds/slave/test/build/application 09:34:22 INFO - Reading from file tmpfile_stdout 09:34:22 INFO - Output received: 09:34:22 INFO - /builds/slave/test/build/application/firefox/firefox 09:34:22 INFO - Running post-action listener: _resource_record_post_action 09:34:22 INFO - [mozharness: 2017-03-14 16:34:22.895763Z] Finished install step (success) 09:34:22 INFO - [mozharness: 2017-03-14 16:34:22.896039Z] Running run-tests step. 09:34:22 INFO - Running pre-action listener: _resource_record_pre_action 09:34:22 INFO - Running main action method: run_tests 09:34:22 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 09:34:22 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 09:34:22 INFO - Python 2.7.3 09:34:22 INFO - Return code: 0 09:34:22 INFO - grabbing minidump binary from tooltool 09:34:22 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 09:34:22 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 0x1ae0850>, '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 0x1a556d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1a55b60>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 09:34:22 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 09:34:22 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 09:34:22 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 09:34:22 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 09:34:22 INFO - Return code: 0 09:34:22 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 09:34:22 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 09:34:22 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 09:34:22 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 09:34:22 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 09:34:22 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Beta', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/SWlXTsUfQ3eVHfbMtpvdEg/artifacts/public/build/target.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-087', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log'] in /builds/slave/test/build 09:34:22 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Mozilla-Beta --suite dromaeojs --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/SWlXTsUfQ3eVHfbMtpvdEg/artifacts/public/build/target.crashreporter-symbols.zip --title talos-linux64-ix-087 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log 09:34:22 INFO - Using env: {'DISPLAY': ':0', 09:34:22 INFO - 'HOME': '/home/cltbld', 09:34:22 INFO - 'LANG': 'en_US.UTF-8', 09:34:22 INFO - 'LANGUAGE': 'en_US:en', 09:34:22 INFO - 'LOGNAME': 'cltbld', 09:34:22 INFO - 'MAIL': '/var/mail/cltbld', 09:34:22 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 09:34:22 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 09:34:22 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:34:22 INFO - 'MOZ_NO_REMOTE': '1', 09:34:22 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 09:34:22 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:34:22 INFO - 'NO_EM_RESTART': '1', 09:34:22 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:34:22 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:34:22 INFO - 'PWD': '/builds/slave/test', 09:34:22 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 09:34:22 INFO - 'SHELL': '/bin/bash', 09:34:22 INFO - 'SHLVL': '1', 09:34:22 INFO - 'TERM': 'linux', 09:34:22 INFO - 'TMOUT': '86400', 09:34:22 INFO - 'USER': 'cltbld', 09:34:22 INFO - 'XDG_SESSION_COOKIE': 'ca619d3d7d62c99d832f7b8a000001c4-1489509208.45274-2124180520', 09:34:22 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:34:22 INFO - '_': '/tools/buildbot/bin/python'} 09:34:22 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Beta', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/SWlXTsUfQ3eVHfbMtpvdEg/artifacts/public/build/target.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-087', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log'] with output_timeout 3600 09:34:23 INFO - mozversion application_buildid: 20170314154032 09:34:23 INFO - mozversion application_changeset: a5807cd917b25038d8c00428ee42623e2f907c7e 09:34:23 INFO - mozversion application_display_name: Firefox 09:34:23 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 09:34:23 INFO - mozversion application_name: Firefox 09:34:23 INFO - mozversion application_remotingname: firefox 09:34:23 INFO - mozversion application_repository: https://hg.mozilla.org/releases/mozilla-beta 09:34:23 INFO - mozversion application_vendor: Mozilla 09:34:23 INFO - mozversion application_version: 53.0 09:34:23 INFO - mozversion platform_buildid: 20170314154032 09:34:23 INFO - mozversion platform_changeset: a5807cd917b25038d8c00428ee42623e2f907c7e 09:34:23 INFO - mozversion platform_repository: https://hg.mozilla.org/releases/mozilla-beta 09:34:23 INFO - mozversion platform_version: 53.0 09:34:23 INFO - using testdate: 1489509263 09:34:23 INFO - actual date: 1489509263 09:34:23 INFO - starting webserver on 'localhost:51387' 09:34:23 INFO - SUITE-START | Running 2 tests 09:34:23 INFO - TEST-START | dromaeo_css 09:34:23 INFO - operating with platform_type : linux_ 09:34:23 INFO - Initialising browser for dromaeo_css test... 09:34:23 INFO - TEST-INFO | started process 15983 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpjzMWOK/profile http://localhost:51387/getInfo.html) 09:34:27 INFO - PROCESS | 15983 | __metrics Screen width/height:1600/1200 09:34:27 INFO - PROCESS | 15983 | colorDepth:24 09:34:27 INFO - PROCESS | 15983 | Browser inner width/height: 1024/697 09:34:27 INFO - PROCESS | 15983 | __metrics 09:34:28 INFO - PROCESS | 15983 | JavaScript error: resource://gre/modules/AsyncShutdown.jsm, line 692: Error: Phase "quit-application-granted" is finished, it is too late to register completion condition "SessionStore: flushing all windows" 09:34:28 INFO - PROCESS | 15983 | JavaScript error: resource://app/modules/BrowserUsageTelemetry.jsm, line 303: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 09:34:29 INFO - TEST-INFO | 15983: exit 0 09:34:29 INFO - Browser initialized. 09:34:29 INFO - Running cycle 1/1 for dromaeo_css test... 09:34:29 INFO - TEST-INFO | started process 16074 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpjzMWOK/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 09:34:40 INFO - PROCESS | 16074 | RSS: Main: 139915264 09:34:40 INFO - PROCESS | 16074 | 09:37:41 INFO - PROCESS | 16074 | Cycle 1(1): loaded http://localhost:51387/tests/dromaeo/cssquery-dojo.html (next: http://localhost:51387/tests/dromaeo/cssquery-ext.html) 09:37:42 INFO - PROCESS | 16074 | RSS: Main: 239722496 09:37:42 INFO - PROCESS | 16074 | 09:40:44 INFO - PROCESS | 16074 | Cycle 1(1): loaded http://localhost:51387/tests/dromaeo/cssquery-ext.html (next: http://localhost:51387/tests/dromaeo/cssquery-jquery.html) 09:40:44 INFO - PROCESS | 16074 | RSS: Main: 225644544 09:40:44 INFO - PROCESS | 16074 | 09:43:46 INFO - PROCESS | 16074 | Cycle 1(1): loaded http://localhost:51387/tests/dromaeo/cssquery-jquery.html (next: http://localhost:51387/tests/dromaeo/cssquery-mootools.html) 09:43:47 INFO - PROCESS | 16074 | RSS: Main: 177717248 09:43:47 INFO - PROCESS | 16074 | 09:46:49 INFO - PROCESS | 16074 | Cycle 1(1): loaded http://localhost:51387/tests/dromaeo/cssquery-mootools.html (next: http://localhost:51387/tests/dromaeo/cssquery-prototype.html) 09:46:49 INFO - PROCESS | 16074 | RSS: Main: 174968832 09:46:49 INFO - PROCESS | 16074 | 09:49:52 INFO - PROCESS | 16074 | Cycle 1(1): loaded http://localhost:51387/tests/dromaeo/cssquery-prototype.html (next: http://localhost:51387/tests/dromaeo/cssquery-yui.html) 09:49:53 INFO - PROCESS | 16074 | RSS: Main: 173146112 09:49:53 INFO - PROCESS | 16074 | 09:52:55 INFO - PROCESS | 16074 | Cycle 1(1): loaded http://localhost:51387/tests/dromaeo/cssquery-yui.html (next: http://localhost:51387/tests/dromaeo/cssquery-dojo.html) 09:52:55 INFO - PROCESS | 16074 | RSS: Main: 263196672 09:52:55 INFO - PROCESS | 16074 | 09:52:55 INFO - PROCESS | 16074 | __start_tp_report 09:52:55 INFO - PROCESS | 16074 | _x_x_mozilla_page_load 09:52:55 INFO - PROCESS | 16074 | _x_x_mozilla_page_load_details 09:52:55 INFO - PROCESS | 16074 | |i|pagename|runs| 09:52:55 INFO - PROCESS | 16074 | |0;dojo.html;3231.531427942948;3267.8856240031605;3270.1334146451195;3292.950605740913;3320.6181289151755;5304.310439642846;5356.4911333423315;5438.673679579223;5441.537469315113;5443.700596467193;5402.648827826189;5435.211894275338;5442.9727851360685;5444.91832622511;5447.700376479302;4852.514748525137;4870.0746858096845;4899.902001959958;4927.852164435073;4947.282644016615;4793.832215872445;4811.109944660249;4903.558679718824;4939.135651261015;5003.5997120230295;4864.416270047599;4875.366202393684;4897.167481528131;4945.9258111128365;4974.7015179089185;4980.053789779949;4987.775550100254;4988.4762099979525;4988.800447982077;5027.723475208862;4745.477997420281;4909.870729732146;4924.089043526959;4945.109880221558;4964.975175124101;5223.138182199932;5225.425203227642;5303;5313.521783039507;5373.35519737634;5744.3394009689;5751.741171647286;5751.971240143773;5752.165935939265;5754.424557544254;5729.484346408802;5776.104703770922;5782.508486778629;5791.942080579224;5794.130880367937;5291.603129765283;5299.5230429261555;5355;5375.677459352412;5387.595930305164;5885.705714714247;5901.911471327933;5903.793367232126;5908.113782932594;5932.940670593325;5686.2039314496005;5689.544836413077;5693.629914055573;5697.914531282034;5701.2018317435595;5675.659460432387;5700.914486282709;5711.7144142792695;5714.0571805652435;5726.513246374022;5761.510271626875;5807.128930660435;5822.563307751935;5845.152452894306;5845.473907348359;5814.069748840166;5818.854528636818;5825.88348233033;5828.679422631796;5840.707964601838;3955.0705584187695;3973.4238535412205;4089.4274801527213;4104.856330028435;4120.114175452292;3719.0702324418894;3735.458358537997;3748.1379282765115;3750.2686976039954;3760.417135344026;5639.8590035249445;5640.5487560995025;5648.576356773258;5652.152177173457;5656;5640.492355688008;5658.91511627326;5671.461211184931;5880.882382352329;5913;5493.423190565013;5560.082586373284;5561.165825126263;5561.443855614487;5583.469570390806;4894.632902532324;4895.6083513318845;4896.167651499253;4897.681650692765;4926.827561035347;5963.4334738199805;6028.336882942785;6035.245594300713;6044.788432404845;6047.909281360783;5730.455606717355;5749.511291540099;5754.338251101177;5807.767689292381;5844.327902291291;6021;6024.939750602438;6026.819195424145;6031.09533569968;6046.848828779316;5483.588730845123;5604.075327570905;5660.377358490645;5725.942740572707;5734.655920644775;5619.578531610227;5645.125005624135;5691.857703557444;5711.600187986967;5848.4151584841175;5606.635568688022;5614.52276556481;5639.7180140993605;5648.378678345297;5667.1782591524825;5640.802571909963;5650.23721797552;5655.915161272666;5657.12314591239;5659.717014149359;5486.862828429321;5515.503604675599;5622.6345287557815;5630.465105814941;5654.575906807088;5742.942570574241;5744.712764361849;5751.971240143773;5757.107648314518;5776.844631073718;5425.891482170414;5577.609567330248;5582.637128586629;5623.044082506066;5647.124695672177 09:52:55 INFO - PROCESS | 16074 | |1;ext.html;548.3803302268436;596.4333882811329;622.5299898576573;627.6422439209653;651.4267444648708;37175.44236836449;40346.59653403465;40371.192576148496;47883.52116478834;48571.271430928566;51399;51956;51994.480055199434;52004.739976300065;52013.479865201334;9225.72322830316;9407.247420206368;9411.576479058425;9411.858822117674;9414.52927353633;8731;8904.465732056098;11155.274907131052;11401.942990285079;11416;11393.48729307179;11438.084953203725;11462.598809041685;11465.484053217584;11465.484053217626;11479.196456248066;11548.133889958202;11551.768964620745;11556.479958401893;11560.884391156107;11422.428878556122;11454.370009649467;11476;11489.253198542068;11509.079273658088;45773.084538309384;46015;46051;46087.769561152316;46125.30812037822;4134.751914885116;4181.895452613709;4205.053862880858;4230.809613567397;4268.423762792015;35337.469937950955;36091.45862812034;36186;36270.45594316087;36290.27419451623;4558.77206139695;4593.035462552868;4604.907901841944;4630.536946305376;4693.06138772247;351594;351836;352263;352800;352882;71459;71575.2842471579;71675;71753.2824671757;71765.64117179485;75489.622551888;75580;75644;75948;76193.61903190559;19826.90086549558;20400.795992040188;20414.69377959332;20429.387118386472;20453;13324.73350532984;13618.86381136176;14964.551063468114;14982;14988.700225995419;18756.24975001012;19781.307654232034;20314.28899988493;20378.592428151354;21330.466738331357;6317.4946004319545;6514.315996820361;6536.901946470807;6575.704093315812;6638.4357329626555;977.5307852230969;984.5274268351232;988.6737376665683;990.4948476277151;1007.7178390050798;34244.486332705026;34343.31313373719;34463;34560.48159277613;34813.82593087018;1107.7839821234782;1180.9586664466874;1186.4483015397882;1224.6570960131178;1234.4136535145913;18139.54651133732;18223.45329640113;18315;18322.267109315744;18447.446576602724;488020;491965;492281;492853;493214;70089.64955175192;70093;70157;70192.64903675449;70206.297937021;1285.3958639439636;1490.9776353354707;1510.8715759160596;1572.4339237874356;1580.5969477783322;30587.694123058485;34683.65316346804;35027.47458788069;35049.8247508771;35444;58387;59322.11016834837;59518;59629.40370596412;59670;385891;386502;386657;386706;387631;28065.579016314365;38684.41973370346;42576.36135457909;44469.55530444784;45765.77117114393;43377.783111085504;43769.562304377825;48101.27848082212;48342.27486587634;48485.27272090992;39511.60488395079;39669.404958925064;40027.3995890056;40357.596424035386;41585.792071039454;39065.02337441587;39746.40380394354;40649.79675101605;41151;41273.1745365097;39417;39978.2004359917;40125.19749604933;40771.184576307714;40937;33650.83174584111;35404.11489712778;35852.64147358493;36076.45885311775;36220.4566931491;26826.329341766614;27188.1843544694;27263.86368068147;27298.181054568395;27402.17793466199 09:52:55 INFO - PROCESS | 16074 | |2;jquery.html;444.69316171841405;449.7863514830456;451.55521811016143;453.1186841593102;468.39810843066664;19951.401457956268;21562.353129406125;21874.89062554687;22024.559508809813;22222.1111155554;20714.378568642926;21309.147634094617;21532.138714451405;21854.672179917274;22925.312240632767;5489.313835770528;5590.748416321255;5590.797978434635;5668.319801623811;5691.146328050784;6068.6662233577135;6084.300305464862;6120.173776540177;6123.938760612381;6129.601575897553;5493.066178749602;5527.2538207341895;5874.177615133864;6089.969550152266;6114.2357205349335;5497.065498865202;5524.281843360378;5530.751116199761;5531.225628412026;5531.612787104904;5273.288106105665;5409.7295135243085;5439.374471935738;5498.80754173602;5505.449455054462;15352.771778257713;15410.383584656713;15440.150791706452;15462.845371546253;15484;3019.728224459809;3169.429502689515;3175.2061984503875;3199.520071989197;3238.5466034755154;11191.66425007251;11300.491477883515;11315.15136364776;13938.58184254474;14470.49353272641;1983.930562430308;2005.7492813398326;2058.7735349111585;2185.311626837557;2196.791304826039;82040;92452;94469;94650;96946.51526742321;12176.81734773979;12394.442250098768;12492.375381230902;12591.559295424617;12691.555795547112;18020.549486262687;18065.367712130013;18068.36760713395;18075.09624518795;18092.095395230448;8847.601857916408;8873.955630221808;8993.685221017233;9070.27437804974;9119;8347.707830225912;8354.874676879852;8368.24685778283;8588.441751286146;8606.827863442697;5328.227407026037;5473.0969390051;5481.780728770885;5483.287172667528;5589.077802162679;2160.735969457885;2166.5450255446217;2182.4434769134086;2189.6715492676226;2205.746339170984;919.3840127114715;935.209747763139;935.4340623922429;942.853857652065;947.0434860790651;19807.32601098862;21362.14551417957;21365;21487.78512214858;21538.89230553837;948.2035090523993;1027.275770581738;1073.9248252622242;1092.6012005617893;1110.9166812488934;10973.177011724152;11511.136664750176;11523.596674116367;11532.423378831025;11568.537258509734;694578;696917;701520;728366;731653;86294;104058;111183.44408277907;111251.44374278077;113710;1100.9724756881142;1122.253701288634;1131.0951239008925;1134.8581427321585;1146.5643055638805;17359.56601084983;17628.383006594708;17670.381536646157;17706.114694265492;17974.2810287587;45835.31247031364;45865.770671146434;46156.07687846291;46250.7687461574;46855.29717054179;64717;64928;65347;66116.33883661102;66469.66765166144;8559.95720021396;8627.568621568771;8821.955890220508;9074.500902450429;9246.861297080415;12884.291363974697;13809.102408343426;14083;14239.359228834934;14453.566393008226;11377.317360958368;11770.82343764827;11810.055195584504;12254.754904901674;12805.103642744918;11491.482883270106;12273.140880138304;12388;12684.429200685807;13045.934770326088;12190.146689731988;12191.390430478617;12435.75128497443;12503.499860005499;12693.555725549562;8783.736487905373;8821.073787252502;9027.45835249887;9387.10822471864;9888.357256778287;12075.154739168174;12117.27296362221;12206.87793122093;12470.438830252479;12565.874341256836 09:52:55 INFO - PROCESS | 16074 | |3;mootools.html;1405.7329107469586;1509.9471518496848;1511.5616471223345;1528.8853335999802;1533.2257210108894;7869.724559640406;8312.750617481477;8525.829483410329;8538.27424668904;8676.956615216915;8487.660493580264;8554.059053504125;8565.100664430238;8565.271951884097;8566.785830354243;2010.0954570443287;2080;2440.2679196241147;2473.418746594549;2477.900883964648;2419.2621250518587;2519.6346529753173;2527.5576774064557;2545.083769842855;2546.936326591841;2461.1509029384924;2467.346153269385;2484.3416494628937;2490.489449662815;2506.3608779761134;2470.7405722399158;2484.428581426273;2498.2380373985925;2517.5720127578356;2518.294877434312;2396.269137912936;2423.4426082001237;2484.24230609664;2488.912888048928;2489.775920167194;8881.822363552692;8937.50843703596;8998.505082220476;9015.36892417531;9033.367664263438;5475.288212532345;5605.822777216789;5614.887702245973;5623.8594035149035;5631.042722737145;3430.142464383904;3479.739019573542;3508.438649816043;3509.052555809917;3546.716262698978;1382.1637909065073;1414.6887684709347;1425.0879437160227;1432.5773896700393;1499.2967370594613;12204.511819527208;12313.876861231363;12347.444365003596;12422.937885310606;12434.378281086;4769.427668679711;4880.511948805091;4886.096072226649;4962.454130045692;5014.548690617789;9787.36382135159;9798.951005245071;9806.509674516246;9815.75460613476;9835.213182945346;5501.889962200734;5547.195656629766;5559.360673522516;5564.610477266633;5566.165075238666;4201.768902710319;4873.975630121827;4940.2342636891335;5005.549500544968;5094.872628184251;4142.150859073882;4212.3681447782465;4266.466691663542;4301.0537681709975;4302.397664326997;1344.8117263583106;1365.208179256029;1371.9657008574666;1380.2339701465582;1389.0693235532217;949.6248981652209;955.5986485675894;957.368137029571;959.7360725800461;981;5719.914201286984;5724.79963201286;5780.913286300709;5797.304323481125;5826.783367632788;629.5530173576811;631.6620607974803;636.9299377068519;643.2088531106672;649.1820306413953;3534.840932158059;3564.269324788412;3596.9100772480897;3643.4899114124046;3659.3779057560278;9943.403395796275;10236.53935572901;10266.6406675766;10267.691969240936;10292.228082893664;10046.296759226783;10117.392956422638;10131.493425328705;10204.489775511343;10213.285070045025;8106.675732970615;8238.258556730043;8241.587920603946;8263.421560490708;8272;5385.973070134781;5386.649867758583;5386.784528618811;5438.021156191923;5462.262594549844;9318.161365477139;9334.766630834283;9340.766480838034;9346.299027572823;9455.14903658674;9431.905680943102;9523.666671666459;9523.952380238054;9624.903750962681;9630.711078667651;6472.061551074974;6690.69891854858;6692.464602831859;7432.851342973002;7514.549127052394;7101.751438699827;8096.87854682192;8142.10436851934;8344.249017588447;8351.95824020876;7173.928260717326;7263.0921134858145;7302.233265507258;7340;7377.557346559223;7184.389326907271;7212.8918066228;7272.490925635367;7281.453890958093;7304.123505179413;6369.840753981188;6451.41937225652;6470.902936455863;6473.061406096184;6479.708413121327;5049;5063.746812659426;5083.262926875656;5109.463506331782;5267.183586544092;4812.735299558558;4883.926741098958;4923.753812309442;4943.233798761198;4998.375203099613 09:52:55 INFO - PROCESS | 16074 | |4;prototype.html;411.5041375142953;416.0576294692522;419.870548225274;427.97004209705335;432.87879393769737;5293;5315.123004704224;5317.218731724877;5337.638902079969;5345.224942383357;5098.566621837139;5128.7948482060765;5256.211568264762;5283.313169287997;5320;4243.305501006867;4249.150169966019;4255.510616279121;4272.124214536028;4273.316269396897;4282.486101667789;4284.371938663304;4292.935605965913;4299.935500967488;4310.612044915957;3960.5049368828895;4119.054875763828;4120.732152410099;4147.5645057269;4261.850835220768;4146.1914926589325;4147.668186545099;4147.71420859533;4149.365153127756;4152.37714342848;3694.9815250923843;3726.608706085849;3732.720045996534;3734.458503517002;3760.811959402019;4962.702237865704;5236.345456817898;5244.8688782780355;5256.132738098209;5273.683578985273;4824.5899098576665;4828.686135401223;4851.781669824831;4855.198892182786;4864.756762161913;5598.832035038955;5606.411326810667;5641.943580564224;5645.221755147116;5645.7579332546775;4063.7155399122075;4086.6730661547003;4127.47283505102;4135.841964250015;4141.109661422808;5488.862778430531;5597.468240517103;5730.627509211888;5748;5784.68184249866;4057.594240575978;4138.193052354762;4157.729747566398;4177.8537751178565;4190.559991200941;4250.128723611652;4269.530351661315;4273.786310684453;4276.2089013532595;4286.678499112517;4615.3999980003055;4651.976740116278;4734.526547345238;4752.619790416758;4765.380500534978;5555.972220138873;5561.916571251434;5570.910908409346;5586.385497595261;5588.608797384144;1401.1242973141786;1411.1495669998928;1412.0398129272194;1416.9008169428248;1428.6214153249398;954.6849539651898;978.7259567321162;987.2003677021636;987.511181964932;992.4839083676592;5213.661112027706;5215.869603259949;5246.737663116829;5266.315379000705;5270.683758974474;5409.26974858397;5449.945500545023;5453.400125986138;5461.644993075517;5489.231507588941;5201.765920533585;5348.5186333230195;5523.861903452445;5563.666180029211;5573.972130139324;2944.102048875071;2948.9852550737537;2954.3943491584173;2956.6051498286456;2958.2604348912773;5488;5728.79949201776;5763.510101641407;5772.307323121168;5822.883542329129;5551.944480555143;5624.943750562442;5672.517835983987;5693.202951586781;5703.572232082611;5664.660120392789;5811;5831.475167234969;5834.504067154339;5844.59087863854;5270.420253772006;5447.972760136174;5448.536874365724;5461.672299662033;5536.889262214814;5371.758270877742;5405.567554595545;5437.374701909331;5481.342238931354;5523.4200408956485;5800.738966746591;5942.227510423791;5970.164177015308;6027.427394397525;6033.758649653964;4179.6029377209115;4208.894777630584;4217.95782042188;4233.132207897312;4240.703150779415;5587.804426845041;5679.318481782213;5700.372958974593;5711.771529138788;5713.685747283939;5490.533304669148;5496.203050557567;5504.834854954358;5528.778848846162;5560.944390556043;5402.58085706741;5488.286522752017;5542.972285138549;5570.693611851387;5590.413006634245;5436.891262174813;5452.6640972960295;5465.535429488538;5489.972550137224;5518.365387980273;5500.669959802424;5513.61404701667;5550.306211723535;5555.527780138734;5577.928112477995;5157.277981082577;5376.301080859464;5443.210734443563;5445.564354851682;5501.4223506532835 09:52:55 INFO - PROCESS | 16074 | |5;yui.html;716.6631683108939;741.7997140771992;747.8279995601011;786.1548835002374;796.7649543384701;15683.529494115195;15742.134182619966;15776.921115394407;15909.045457272558;16223.513294601165;13806.585802425918;13896.791548126786;13933.094348867342;15740.976836505619;15912.965657232271;813.8046868751502;828.5857071464268;831.2477208126655;831.4304701279613;832.1678321678322;697.6302559643372;720.9315115064061;817.513579420244;833.5707110837923;839.2782207301716;884.1026358246353;885.2165833237567;885.8272636835819;886.0873300500494;886.1448702002566;877.5919197573127;878.0253918150847;878.2666473494639;879.1252703559935;879.53824242273;648.2609824799732;649.7888186339459;649.9610023398563;649.9870002599969;650.1288273713247;16049.91975040129;16163.676726465404;16270.26783794732;16870.746938795804;17035;15633.296501657453;15836;15846;15958.920205399016;16150.434734784227;12810.55163069288;12904.096713230078;12921.28932908699;12967.286799226038;12971.67570810728;3962.6235507627016;3994.940075898864;3998.280309544281;4077.8572749953905;4079.714419990602;80484.59757701174;81648.59175704143;81909;82552;84477.57761211216;11733.4719937603;11740.647780566596;11745.17783755146;11767.176297659253;11905.940470297766;21619;21665.45836354072;21706.78293217079;21839.344819655435;21897.12411503522;8244.692720808076;8387.83224335522;8425.536595487307;8464.238218560358;8562.61468233931;4514.6388288936805;4564.7717614119165;4577.931331030038;4621.260598304255;4640.883977900579;3796.6393192646656;3874.7675139491157;3912.7456715313415;3914.980425097913;3919.0790164311366;646.9159009328852;647.3688154049764;650.2716957008087;650.4146268358515;664.3920812456645;727.9490435669452;737.2774680812834;753.3408267765705;755.4578842195971;756.1380619143628;10153.593856245816;10357;10412.219083568763;10422.739431514272;10452.268341216042;589.2016317889284;591.9852003699942;598.628850112924;601.2034054877305;608.8477880529867;4863.586595139382;4941;4974.950250497449;4979.352684151109;4991.376077990251;67301.3269867295;73631.63184184044;74847.25152748512;87012.56493717617;90120;58922;74762.25237747662;75628.24371756212;76530;79792;66721.66639166774;66787.66606166938;67437.3256267431;67687;69973.65013175004;10471.528781205016;10669.41318227505;10762.246642734934;11188.83216751733;11315.603953861575;45382.09235815199;46443.303350449096;46470.767646161556;46516.7674161627;47783.52216477791;55843.441565583824;58194.4180558189;58848;59436.40563594309;59916.700416499385;12520;12703.174293670882;12795.80806287925;12996.610101696964;13033.283169425773;13861.584152475441;13927.57103840117;14081.366338514586;14099.224542650252;14100.435982560582;13056.432781878679;13304.667383315107;13650.26994601064;14046.578602641937;14114.647133821736;12130.090243231616;12201.145919785884;12397.132200745862;12564.811527827273;13272.32719779271;13299.135556188818;13475.932620336836;13646;13742.450301988209;13842.4463021478;10800.567977281135;10940.288881222696;11224.494897729459;11472.598459054227;11659;9989.60041598328;10606.469676516297;10840.837387439036;10854.891451085388;11033.503492343025 09:52:55 INFO - PROCESS | 16074 | __end_tp_report 09:52:55 INFO - PROCESS | 16074 | __start_cc_report 09:52:55 INFO - PROCESS | 16074 | _x_x_mozilla_cycle_collect,960 09:52:55 INFO - PROCESS | 16074 | __end_cc_report 09:52:55 INFO - PROCESS | 16074 | __startTimestamp1489510375447__endTimestamp 09:52:55 INFO - PROCESS | 16074 | 09:52:55 INFO - PROCESS | 16074 | ------- Summary: start ------- 09:52:55 INFO - PROCESS | 16074 | Number of tests: 6 09:52:55 INFO - PROCESS | 16074 | 09:52:55 INFO - PROCESS | 16074 | [#0] dojo.html Cycles:165 Average:5358.29 Median:5630.47 stddev:633.92 (11.3%) stddev-sans-first:613.52 09:52:55 INFO - PROCESS | 16074 | Values: 3231.5 3267.9 3270.1 3293.0 3320.6 5304.3 5356.5 5438.7 5441.5 5443.7 5402.6 5435.2 5443.0 5444.9 5447.7 4852.5 4870.1 4899.9 4927.9 4947.3 4793.8 4811.1 4903.6 4939.1 5003.6 4864.4 4875.4 4897.2 4945.9 4974.7 4980.1 4987.8 4988.5 4988.8 5027.7 4745.5 4909.9 4924.1 4945.1 4965.0 5223.1 5225.4 5303.0 5313.5 5373.4 5744.3 5751.7 5752.0 5752.2 5754.4 5729.5 5776.1 5782.5 5791.9 5794.1 5291.6 5299.5 5355.0 5375.7 5387.6 5885.7 5901.9 5903.8 5908.1 5932.9 5686.2 5689.5 5693.6 5697.9 5701.2 5675.7 5700.9 5711.7 5714.1 5726.5 5761.5 5807.1 5822.6 5845.2 5845.5 5814.1 5818.9 5825.9 5828.7 5840.7 3955.1 3973.4 4089.4 4104.9 4120.1 3719.1 3735.5 3748.1 3750.3 3760.4 5639.9 5640.5 5648.6 5652.2 5656.0 5640.5 5658.9 5671.5 5880.9 5913.0 5493.4 5560.1 5561.2 5561.4 5583.5 4894.6 4895.6 4896.2 4897.7 4926.8 5963.4 6028.3 6035.2 6044.8 6047.9 5730.5 5749.5 5754.3 5807.8 5844.3 6021.0 6024.9 6026.8 6031.1 6046.8 5483.6 5604.1 5660.4 5725.9 5734.7 5619.6 5645.1 5691.9 5711.6 5848.4 5606.6 5614.5 5639.7 5648.4 5667.2 5640.8 5650.2 5655.9 5657.1 5659.7 5486.9 5515.5 5622.6 5630.5 5654.6 5742.9 5744.7 5752.0 5757.1 5776.8 5425.9 5577.6 5582.6 5623.0 5647.1 09:52:55 INFO - PROCESS | 16074 | 09:52:55 INFO - PROCESS | 16074 | [#1] ext.html Cycles:180 Average:60266.17 Median:39707.90 stddev:109204.73 (275.0%) stddev-sans-first:109419.04 09:52:55 INFO - PROCESS | 16074 | Values: 548.4 596.4 622.5 627.6 651.4 37175.4 40346.6 40371.2 47883.5 48571.3 51399.0 51956.0 51994.5 52004.7 52013.5 9225.7 9407.2 9411.6 9411.9 9414.5 8731.0 8904.5 11155.3 11401.9 11416.0 11393.5 11438.1 11462.6 11465.5 11465.5 11479.2 11548.1 11551.8 11556.5 11560.9 11422.4 11454.4 11476.0 11489.3 11509.1 45773.1 46015.0 46051.0 46087.8 46125.3 4134.8 4181.9 4205.1 4230.8 4268.4 35337.5 36091.5 36186.0 36270.5 36290.3 4558.8 4593.0 4604.9 4630.5 4693.1 351594.0 351836.0 352263.0 352800.0 352882.0 71459.0 71575.3 71675.0 71753.3 71765.6 75489.6 75580.0 75644.0 75948.0 76193.6 19826.9 20400.8 20414.7 20429.4 20453.0 13324.7 13618.9 14964.6 14982.0 14988.7 18756.2 19781.3 20314.3 20378.6 21330.5 6317.5 6514.3 6536.9 6575.7 6638.4 977.5 984.5 988.7 990.5 1007.7 34244.5 34343.3 34463.0 34560.5 34813.8 1107.8 1181.0 1186.4 1224.7 1234.4 18139.5 18223.5 18315.0 18322.3 18447.4 488020.0 491965.0 492281.0 492853.0 493214.0 70089.6 70093.0 70157.0 70192.6 70206.3 1285.4 1491.0 1510.9 1572.4 1580.6 30587.7 34683.7 35027.5 35049.8 35444.0 58387.0 59322.1 59518.0 59629.4 59670.0 385891.0 386502.0 386657.0 386706.0 387631.0 28065.6 38684.4 42576.4 44469.6 45765.8 43377.8 43769.6 48101.3 48342.3 48485.3 39511.6 39669.4 40027.4 40357.6 41585.8 39065.0 39746.4 40649.8 41151.0 41273.2 39417.0 39978.2 40125.2 40771.2 40937.0 33650.8 35404.1 35852.6 36076.5 36220.5 26826.3 27188.2 27263.9 27298.2 27402.2 09:52:55 INFO - PROCESS | 16074 | 09:52:55 INFO - PROCESS | 16074 | [#2] jquery.html Cycles:180 Average:36525.56 Median:12213.93 stddev:116674.63 (955.3%) stddev-sans-first:116970.47 09:52:55 INFO - PROCESS | 16074 | Values: 444.7 449.8 451.6 453.1 468.4 19951.4 21562.4 21874.9 22024.6 22222.1 20714.4 21309.1 21532.1 21854.7 22925.3 5489.3 5590.7 5590.8 5668.3 5691.1 6068.7 6084.3 6120.2 6123.9 6129.6 5493.1 5527.3 5874.2 6090.0 6114.2 5497.1 5524.3 5530.8 5531.2 5531.6 5273.3 5409.7 5439.4 5498.8 5505.4 15352.8 15410.4 15440.2 15462.8 15484.0 3019.7 3169.4 3175.2 3199.5 3238.5 11191.7 11300.5 11315.2 13938.6 14470.5 1983.9 2005.7 2058.8 2185.3 2196.8 82040.0 92452.0 94469.0 94650.0 96946.5 12176.8 12394.4 12492.4 12591.6 12691.6 18020.5 18065.4 18068.4 18075.1 18092.1 8847.6 8874.0 8993.7 9070.3 9119.0 8347.7 8354.9 8368.2 8588.4 8606.8 5328.2 5473.1 5481.8 5483.3 5589.1 2160.7 2166.5 2182.4 2189.7 2205.7 919.4 935.2 935.4 942.9 947.0 19807.3 21362.1 21365.0 21487.8 21538.9 948.2 1027.3 1073.9 1092.6 1110.9 10973.2 11511.1 11523.6 11532.4 11568.5 694578.0 696917.0 701520.0 728366.0 731653.0 86294.0 104058.0 111183.4 111251.4 113710.0 1101.0 1122.3 1131.1 1134.9 1146.6 17359.6 17628.4 17670.4 17706.1 17974.3 45835.3 45865.8 46156.1 46250.8 46855.3 64717.0 64928.0 65347.0 66116.3 66469.7 8560.0 8627.6 8822.0 9074.5 9246.9 12884.3 13809.1 14083.0 14239.4 14453.6 11377.3 11770.8 11810.1 12254.8 12805.1 11491.5 12273.1 12388.0 12684.4 13045.9 12190.1 12191.4 12435.8 12503.5 12693.6 8783.7 8821.1 9027.5 9387.1 9888.4 12075.2 12117.3 12206.9 12470.4 12565.9 09:52:55 INFO - PROCESS | 16074 | 09:52:55 INFO - PROCESS | 16074 | [#3] mootools.html Cycles:180 Average:5640.20 Median:5386.72 stddev:3100.27 (57.6%) stddev-sans-first:3092.64 09:52:55 INFO - PROCESS | 16074 | Values: 1405.7 1509.9 1511.6 1528.9 1533.2 7869.7 8312.8 8525.8 8538.3 8677.0 8487.7 8554.1 8565.1 8565.3 8566.8 2010.1 2080.0 2440.3 2473.4 2477.9 2419.3 2519.6 2527.6 2545.1 2546.9 2461.2 2467.3 2484.3 2490.5 2506.4 2470.7 2484.4 2498.2 2517.6 2518.3 2396.3 2423.4 2484.2 2488.9 2489.8 8881.8 8937.5 8998.5 9015.4 9033.4 5475.3 5605.8 5614.9 5623.9 5631.0 3430.1 3479.7 3508.4 3509.1 3546.7 1382.2 1414.7 1425.1 1432.6 1499.3 12204.5 12313.9 12347.4 12422.9 12434.4 4769.4 4880.5 4886.1 4962.5 5014.5 9787.4 9799.0 9806.5 9815.8 9835.2 5501.9 5547.2 5559.4 5564.6 5566.2 4201.8 4874.0 4940.2 5005.5 5094.9 4142.2 4212.4 4266.5 4301.1 4302.4 1344.8 1365.2 1372.0 1380.2 1389.1 949.6 955.6 957.4 959.7 981.0 5719.9 5724.8 5780.9 5797.3 5826.8 629.6 631.7 636.9 643.2 649.2 3534.8 3564.3 3596.9 3643.5 3659.4 9943.4 10236.5 10266.6 10267.7 10292.2 10046.3 10117.4 10131.5 10204.5 10213.3 8106.7 8238.3 8241.6 8263.4 8272.0 5386.0 5386.6 5386.8 5438.0 5462.3 9318.2 9334.8 9340.8 9346.3 9455.1 9431.9 9523.7 9524.0 9624.9 9630.7 6472.1 6690.7 6692.5 7432.9 7514.5 7101.8 8096.9 8142.1 8344.2 8352.0 7173.9 7263.1 7302.2 7340.0 7377.6 7184.4 7212.9 7272.5 7281.5 7304.1 6369.8 6451.4 6470.9 6473.1 6479.7 5049.0 5063.7 5083.3 5109.5 5267.2 4812.7 4883.9 4923.8 4943.2 4998.4 09:52:55 INFO - PROCESS | 16074 | 09:52:55 INFO - PROCESS | 16074 | [#4] prototype.html Cycles:180 Average:4679.42 Median:5328.82 stddev:1335.90 (25.1%) stddev-sans-first:1300.67 09:52:55 INFO - PROCESS | 16074 | Values: 411.5 416.1 419.9 428.0 432.9 5293.0 5315.1 5317.2 5337.6 5345.2 5098.6 5128.8 5256.2 5283.3 5320.0 4243.3 4249.2 4255.5 4272.1 4273.3 4282.5 4284.4 4292.9 4299.9 4310.6 3960.5 4119.1 4120.7 4147.6 4261.9 4146.2 4147.7 4147.7 4149.4 4152.4 3695.0 3726.6 3732.7 3734.5 3760.8 4962.7 5236.3 5244.9 5256.1 5273.7 4824.6 4828.7 4851.8 4855.2 4864.8 5598.8 5606.4 5641.9 5645.2 5645.8 4063.7 4086.7 4127.5 4135.8 4141.1 5488.9 5597.5 5730.6 5748.0 5784.7 4057.6 4138.2 4157.7 4177.9 4190.6 4250.1 4269.5 4273.8 4276.2 4286.7 4615.4 4652.0 4734.5 4752.6 4765.4 5556.0 5561.9 5570.9 5586.4 5588.6 1401.1 1411.1 1412.0 1416.9 1428.6 954.7 978.7 987.2 987.5 992.5 5213.7 5215.9 5246.7 5266.3 5270.7 5409.3 5449.9 5453.4 5461.6 5489.2 5201.8 5348.5 5523.9 5563.7 5574.0 2944.1 2949.0 2954.4 2956.6 2958.3 5488.0 5728.8 5763.5 5772.3 5822.9 5551.9 5624.9 5672.5 5693.2 5703.6 5664.7 5811.0 5831.5 5834.5 5844.6 5270.4 5448.0 5448.5 5461.7 5536.9 5371.8 5405.6 5437.4 5481.3 5523.4 5800.7 5942.2 5970.2 6027.4 6033.8 4179.6 4208.9 4218.0 4233.1 4240.7 5587.8 5679.3 5700.4 5711.8 5713.7 5490.5 5496.2 5504.8 5528.8 5560.9 5402.6 5488.3 5543.0 5570.7 5590.4 5436.9 5452.7 5465.5 5490.0 5518.4 5500.7 5513.6 5550.3 5555.5 5577.9 5157.3 5376.3 5443.2 5445.6 5501.4 09:52:55 INFO - PROCESS | 16074 | 09:52:55 INFO - PROCESS | 16074 | [#5] yui.html Cycles:180 Average:18285.31 Median:24973.43 stddev:23530.35 (94.2%) stddev-sans-first:23559.38 09:52:55 INFO - PROCESS | 16074 | Values: 716.7 741.8 747.8 786.2 796.8 15683.5 15742.1 15776.9 15909.0 16223.5 13806.6 13896.8 13933.1 15741.0 15913.0 813.8 828.6 831.2 831.4 832.2 697.6 720.9 817.5 833.6 839.3 884.1 885.2 885.8 886.1 886.1 877.6 878.0 878.3 879.1 879.5 648.3 649.8 650.0 650.0 650.1 16049.9 16163.7 16270.3 16870.7 17035.0 15633.3 15836.0 15846.0 15958.9 16150.4 12810.6 12904.1 12921.3 12967.3 12971.7 3962.6 3994.9 3998.3 4077.9 4079.7 80484.6 81648.6 81909.0 82552.0 84477.6 11733.5 11740.6 11745.2 11767.2 11905.9 21619.0 21665.5 21706.8 21839.3 21897.1 8244.7 8387.8 8425.5 8464.2 8562.6 4514.6 4564.8 4577.9 4621.3 4640.9 3796.6 3874.8 3912.7 3915.0 3919.1 646.9 647.4 650.3 650.4 664.4 727.9 737.3 753.3 755.5 756.1 10153.6 10357.0 10412.2 10422.7 10452.3 589.2 592.0 598.6 601.2 608.8 4863.6 4941.0 4975.0 4979.4 4991.4 67301.3 73631.6 74847.3 87012.6 90120.0 58922.0 74762.3 75628.2 76530.0 79792.0 66721.7 66787.7 67437.3 67687.0 69973.7 10471.5 10669.4 10762.2 11188.8 11315.6 45382.1 46443.3 46470.8 46516.8 47783.5 55843.4 58194.4 58848.0 59436.4 59916.7 12520.0 12703.2 12795.8 12996.6 13033.3 13861.6 13927.6 14081.4 14099.2 14100.4 13056.4 13304.7 13650.3 14046.6 14114.6 12130.1 12201.1 12397.1 12564.8 13272.3 13299.1 13475.9 13646.0 13742.5 13842.4 10800.6 10940.3 11224.5 11472.6 11659.0 9989.6 10606.5 10840.8 10854.9 11033.5 09:52:55 INFO - PROCESS | 16074 | -------- Summary: end -------- 09:52:55 INFO - PROCESS | 16074 | 09:52:56 INFO - TEST-INFO | 16074: exit 0 09:52:56 INFO - TEST-OK | dromaeo_css | took 1113019ms 09:52:56 INFO - TEST-START | kraken 09:52:56 INFO - operating with platform_type : linux_ 09:52:56 INFO - Initialising browser for kraken test... 09:52:56 INFO - TEST-INFO | started process 16375 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpKAuYcB/profile http://localhost:51387/getInfo.html) 09:53:00 INFO - PROCESS | 16375 | __metrics Screen width/height:1600/1200 09:53:00 INFO - PROCESS | 16375 | colorDepth:24 09:53:00 INFO - PROCESS | 16375 | Browser inner width/height: 1024/697 09:53:00 INFO - PROCESS | 16375 | __metrics 09:53:01 INFO - PROCESS | 16375 | JavaScript error: resource://gre/modules/AsyncShutdown.jsm, line 692: Error: Phase "quit-application-granted" is finished, it is too late to register completion condition "SessionStore: flushing all windows" 09:53:01 INFO - PROCESS | 16375 | JavaScript error: resource://app/modules/BrowserUsageTelemetry.jsm, line 303: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 09:53:02 INFO - TEST-INFO | 16375: exit 0 09:53:02 INFO - Browser initialized. 09:53:02 INFO - Running cycle 1/1 for kraken test... 09:53:02 INFO - TEST-INFO | started process 16470 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpKAuYcB/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 09:53:13 INFO - PROCESS | 16470 | RSS: Main: 139509760 09:53:13 INFO - PROCESS | 16470 | 09:53:16 INFO - PROCESS | 16470 | Cycle 1(1): loaded http://localhost:51387/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:51387/tests/kraken/driver.html?testName=audio-beat-detection) 09:53:17 INFO - PROCESS | 16470 | RSS: Main: 181088256 09:53:17 INFO - PROCESS | 16470 | 09:53:19 INFO - PROCESS | 16470 | Cycle 1(1): loaded http://localhost:51387/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:51387/tests/kraken/driver.html?testName=audio-dft) 09:53:20 INFO - PROCESS | 16470 | RSS: Main: 171524096 09:53:20 INFO - PROCESS | 16470 | 09:53:23 INFO - PROCESS | 16470 | Cycle 1(1): loaded http://localhost:51387/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:51387/tests/kraken/driver.html?testName=audio-fft) 09:53:23 INFO - PROCESS | 16470 | RSS: Main: 263020544 09:53:23 INFO - PROCESS | 16470 | 09:53:25 INFO - PROCESS | 16470 | Cycle 1(1): loaded http://localhost:51387/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:51387/tests/kraken/driver.html?testName=audio-oscillator) 09:53:26 INFO - PROCESS | 16470 | RSS: Main: 168935424 09:53:26 INFO - PROCESS | 16470 | 09:53:28 INFO - PROCESS | 16470 | Cycle 1(1): loaded http://localhost:51387/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:51387/tests/kraken/driver.html?testName=imaging-gaussian-blur) 09:53:28 INFO - PROCESS | 16470 | RSS: Main: 171950080 09:53:28 INFO - PROCESS | 16470 | 09:53:31 INFO - PROCESS | 16470 | Cycle 1(1): loaded http://localhost:51387/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:51387/tests/kraken/driver.html?testName=imaging-darkroom) 09:53:32 INFO - PROCESS | 16470 | RSS: Main: 206675968 09:53:32 INFO - PROCESS | 16470 | 09:53:35 INFO - PROCESS | 16470 | Cycle 1(1): loaded http://localhost:51387/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:51387/tests/kraken/driver.html?testName=imaging-desaturate) 09:53:36 INFO - PROCESS | 16470 | RSS: Main: 208908288 09:53:36 INFO - PROCESS | 16470 | 09:53:39 INFO - PROCESS | 16470 | Cycle 1(1): loaded http://localhost:51387/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:51387/tests/kraken/driver.html?testName=json-parse-financial) 09:53:39 INFO - PROCESS | 16470 | RSS: Main: 207818752 09:53:39 INFO - PROCESS | 16470 | 09:53:41 INFO - PROCESS | 16470 | Cycle 1(1): loaded http://localhost:51387/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:51387/tests/kraken/driver.html?testName=json-stringify-tinderbox) 09:53:41 INFO - PROCESS | 16470 | RSS: Main: 170274816 09:53:41 INFO - PROCESS | 16470 | 09:53:43 INFO - PROCESS | 16470 | Cycle 1(1): loaded http://localhost:51387/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:51387/tests/kraken/driver.html?testName=stanford-crypto-aes) 09:53:44 INFO - PROCESS | 16470 | RSS: Main: 178626560 09:53:44 INFO - PROCESS | 16470 | 09:53:46 INFO - PROCESS | 16470 | Cycle 1(1): loaded http://localhost:51387/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:51387/tests/kraken/driver.html?testName=stanford-crypto-ccm) 09:53:46 INFO - PROCESS | 16470 | RSS: Main: 188411904 09:53:46 INFO - PROCESS | 16470 | 09:53:49 INFO - PROCESS | 16470 | Cycle 1(1): loaded http://localhost:51387/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:51387/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 09:53:49 INFO - PROCESS | 16470 | RSS: Main: 195346432 09:53:49 INFO - PROCESS | 16470 | 09:53:52 INFO - PROCESS | 16470 | Cycle 1(1): loaded http://localhost:51387/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:51387/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 09:53:53 INFO - PROCESS | 16470 | RSS: Main: 192331776 09:53:53 INFO - PROCESS | 16470 | 09:53:54 INFO - PROCESS | 16470 | Cycle 1(1): loaded http://localhost:51387/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:51387/tests/kraken/driver.html?testName=ai-astar) 09:53:55 INFO - PROCESS | 16470 | RSS: Main: 242733056 09:53:55 INFO - PROCESS | 16470 | 09:53:55 INFO - PROCESS | 16470 | __start_tp_report 09:53:55 INFO - PROCESS | 16470 | _x_x_mozilla_page_load 09:53:55 INFO - PROCESS | 16470 | _x_x_mozilla_page_load_details 09:53:55 INFO - PROCESS | 16470 | |i|pagename|runs| 09:53:55 INFO - PROCESS | 16470 | |0;ai-astar;102;112;110;112;114;113;111;113;110;113 09:53:55 INFO - PROCESS | 16470 | |1;audio-beat-detection;138;116;122;155;116;117;116;115;132;116 09:53:55 INFO - PROCESS | 16470 | |2;audio-dft;159;160;160;163;159;160;161;160;159;159 09:53:55 INFO - PROCESS | 16470 | |3;audio-fft;75;75;76;113;76;74;75;75;99;76 09:53:55 INFO - PROCESS | 16470 | |4;audio-oscillator;82;82;111;83;83;82;93;83;82;97 09:53:55 INFO - PROCESS | 16470 | |5;imaging-gaussian-blur;117;117;116;117;116;117;116;116;116;116 09:53:55 INFO - PROCESS | 16470 | |6;imaging-darkroom;146;146;147;146;147;146;146;147;146;146 09:53:55 INFO - PROCESS | 16470 | |7;imaging-desaturate;95;97;95;96;96;95;95;96;96;95 09:53:55 INFO - PROCESS | 16470 | |8;json-parse-financial;53;62;51;52;52;53;53;57;51;51 09:53:55 INFO - PROCESS | 16470 | |9;json-stringify-tinderbox;63;63;61;62;64;66;62;64;62;63 09:53:55 INFO - PROCESS | 16470 | |10;stanford-crypto-aes;74;73;82;75;74;85;76;83;75;77 09:53:55 INFO - PROCESS | 16470 | |11;stanford-crypto-ccm;123;120;126;125;119;127;118;119;163;117 09:53:55 INFO - PROCESS | 16470 | |12;stanford-crypto-pbkdf2;155;156;155;154;155;158;156;157;153;158 09:53:55 INFO - PROCESS | 16470 | |13;stanford-crypto-sha256-iterative;61;64;62;61;62;59;59;60;59;60 09:53:55 INFO - PROCESS | 16470 | __end_tp_report 09:53:55 INFO - PROCESS | 16470 | __start_cc_report 09:53:55 INFO - PROCESS | 16470 | _x_x_mozilla_cycle_collect,1498 09:53:55 INFO - PROCESS | 16470 | __end_cc_report 09:53:55 INFO - PROCESS | 16470 | __startTimestamp1489510435051__endTimestamp 09:53:55 INFO - PROCESS | 16470 | 09:53:55 INFO - PROCESS | 16470 | ------- Summary: start ------- 09:53:55 INFO - PROCESS | 16470 | Number of tests: 14 09:53:55 INFO - PROCESS | 16470 | 09:53:55 INFO - PROCESS | 16470 | [#0] ai-astar Cycles:10 Average:111.00 Median:112.50 stddev:3.43 (3.1%) stddev-sans-first:1.41 09:53:55 INFO - PROCESS | 16470 | Values: 102.0 112.0 110.0 112.0 114.0 113.0 111.0 113.0 110.0 113.0 09:53:55 INFO - PROCESS | 16470 | 09:53:55 INFO - PROCESS | 16470 | [#1] audio-beat-detection Cycles:10 Average:124.30 Median:119.50 stddev:13.38 (11.2%) stddev-sans-first:13.24 09:53:55 INFO - PROCESS | 16470 | Values: 138.0 116.0 122.0 155.0 116.0 117.0 116.0 115.0 132.0 116.0 09:53:55 INFO - PROCESS | 16470 | 09:53:55 INFO - PROCESS | 16470 | [#2] audio-dft Cycles:10 Average:160.00 Median:160.00 stddev:1.25 (0.8%) stddev-sans-first:1.27 09:53:55 INFO - PROCESS | 16470 | Values: 159.0 160.0 160.0 163.0 159.0 160.0 161.0 160.0 159.0 159.0 09:53:55 INFO - PROCESS | 16470 | 09:53:55 INFO - PROCESS | 16470 | [#3] audio-fft Cycles:10 Average:81.40 Median:75.50 stddev:13.39 (17.7%) stddev-sans-first:14.00 09:53:55 INFO - PROCESS | 16470 | Values: 75.0 75.0 76.0 113.0 76.0 74.0 75.0 75.0 99.0 76.0 09:53:55 INFO - PROCESS | 16470 | 09:53:55 INFO - PROCESS | 16470 | [#4] audio-oscillator Cycles:10 Average:87.80 Median:83.00 stddev:9.74 (11.7%) stddev-sans-first:10.10 09:53:55 INFO - PROCESS | 16470 | Values: 82.0 82.0 111.0 83.0 83.0 82.0 93.0 83.0 82.0 97.0 09:53:55 INFO - PROCESS | 16470 | 09:53:55 INFO - PROCESS | 16470 | [#5] imaging-gaussian-blur Cycles:10 Average:116.40 Median:116.50 stddev:0.52 (0.4%) stddev-sans-first:0.50 09:53:55 INFO - PROCESS | 16470 | Values: 117.0 117.0 116.0 117.0 116.0 117.0 116.0 116.0 116.0 116.0 09:53:55 INFO - PROCESS | 16470 | 09:53:55 INFO - PROCESS | 16470 | [#6] imaging-darkroom Cycles:10 Average:146.30 Median:146.00 stddev:0.48 (0.3%) stddev-sans-first:0.50 09:53:55 INFO - PROCESS | 16470 | Values: 146.0 146.0 147.0 146.0 147.0 146.0 146.0 147.0 146.0 146.0 09:53:55 INFO - PROCESS | 16470 | 09:53:55 INFO - PROCESS | 16470 | [#7] imaging-desaturate Cycles:10 Average:95.60 Median:96.00 stddev:0.70 (0.7%) stddev-sans-first:0.71 09:53:55 INFO - PROCESS | 16470 | Values: 95.0 97.0 95.0 96.0 96.0 95.0 95.0 96.0 96.0 95.0 09:53:55 INFO - PROCESS | 16470 | 09:53:55 INFO - PROCESS | 16470 | [#8] json-parse-financial Cycles:10 Average:53.50 Median:53.00 stddev:3.47 (6.6%) stddev-sans-first:3.68 09:53:55 INFO - PROCESS | 16470 | Values: 53.0 62.0 51.0 52.0 52.0 53.0 53.0 57.0 51.0 51.0 09:53:55 INFO - PROCESS | 16470 | 09:53:55 INFO - PROCESS | 16470 | [#9] json-stringify-tinderbox Cycles:10 Average:63.00 Median:63.00 stddev:1.41 (2.2%) stddev-sans-first:1.50 09:53:55 INFO - PROCESS | 16470 | Values: 63.0 63.0 61.0 62.0 64.0 66.0 62.0 64.0 62.0 63.0 09:53:55 INFO - PROCESS | 16470 | 09:53:55 INFO - PROCESS | 16470 | [#10] stanford-crypto-aes Cycles:10 Average:77.40 Median:76.50 stddev:4.30 (5.6%) stddev-sans-first:4.38 09:53:55 INFO - PROCESS | 16470 | Values: 74.0 73.0 82.0 75.0 74.0 85.0 76.0 83.0 75.0 77.0 09:53:55 INFO - PROCESS | 16470 | 09:53:55 INFO - PROCESS | 16470 | [#11] stanford-crypto-ccm Cycles:10 Average:125.70 Median:124.00 stddev:13.57 (10.9%) stddev-sans-first:14.36 09:53:55 INFO - PROCESS | 16470 | Values: 123.0 120.0 126.0 125.0 119.0 127.0 118.0 119.0 163.0 117.0 09:53:55 INFO - PROCESS | 16470 | 09:53:55 INFO - PROCESS | 16470 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:155.70 Median:156.00 stddev:1.64 (1.0%) stddev-sans-first:1.72 09:53:55 INFO - PROCESS | 16470 | Values: 155.0 156.0 155.0 154.0 155.0 158.0 156.0 157.0 153.0 158.0 09:53:55 INFO - PROCESS | 16470 | 09:53:55 INFO - PROCESS | 16470 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:60.70 Median:61.00 stddev:1.64 (2.7%) stddev-sans-first:1.73 09:53:55 INFO - PROCESS | 16470 | Values: 61.0 64.0 62.0 61.0 62.0 59.0 59.0 60.0 59.0 60.0 09:53:55 INFO - PROCESS | 16470 | -------- Summary: end -------- 09:53:55 INFO - PROCESS | 16470 | 09:53:56 INFO - TEST-INFO | 16470: exit 0 09:53:56 INFO - TEST-OK | kraken | took 59927ms 09:53:56 INFO - SUITE-END | took 1172s 09:53:56 INFO - Completed test suite (00:19:33) 09:53:56 INFO - javascript benchmark 09:53:56 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3231.531427942948, 3267.8856240031605, 3270.1334146451195, 3292.950605740913, 3320.6181289151755, 5304.310439642846, 5356.4911333423315, 5438.673679579223, 5441.537469315113, 5443.700596467193, 5402.648827826189, 5435.211894275338, 5442.9727851360685, 5444.91832622511, 5447.700376479302, 4852.514748525137, 4870.0746858096845, 4899.902001959958, 4927.852164435073, 4947.282644016615, 4793.832215872445, 4811.109944660249, 4903.558679718824, 4939.135651261015, 5003.5997120230295, 4864.416270047599, 4875.366202393684, 4897.167481528131, 4945.9258111128365, 4974.7015179089185, 4980.053789779949, 4987.775550100254, 4988.4762099979525, 4988.800447982077, 5027.723475208862, 4745.477997420281, 4909.870729732146, 4924.089043526959, 4945.109880221558, 4964.975175124101, 5223.138182199932, 5225.425203227642, 5303.0, 5313.521783039507, 5373.35519737634, 5744.3394009689, 5751.741171647286, 5751.971240143773, 5752.165935939265, 5754.424557544254, 5729.484346408802, 5776.104703770922, 5782.508486778629, 5791.942080579224, 5794.130880367937, 5291.603129765283, 5299.5230429261555, 5355.0, 5375.677459352412, 5387.595930305164, 5885.705714714247, 5901.911471327933, 5903.793367232126, 5908.113782932594, 5932.940670593325, 5686.2039314496005, 5689.544836413077, 5693.629914055573, 5697.914531282034, 5701.2018317435595, 5675.659460432387, 5700.914486282709, 5711.7144142792695, 5714.0571805652435, 5726.513246374022, 5761.510271626875, 5807.128930660435, 5822.563307751935, 5845.152452894306, 5845.473907348359, 5814.069748840166, 5818.854528636818, 5825.88348233033, 5828.679422631796, 5840.707964601838, 3955.0705584187695, 3973.4238535412205, 4089.4274801527213, 4104.856330028435, 4120.114175452292, 3719.0702324418894, 3735.458358537997, 3748.1379282765115, 3750.2686976039954, 3760.417135344026, 5639.8590035249445, 5640.5487560995025, 5648.576356773258, 5652.152177173457, 5656.0, 5640.492355688008, 5658.91511627326, 5671.461211184931, 5880.882382352329, 5913.0, 5493.423190565013, 5560.082586373284, 5561.165825126263, 5561.443855614487, 5583.469570390806, 4894.632902532324, 4895.6083513318845, 4896.167651499253, 4897.681650692765, 4926.827561035347, 5963.4334738199805, 6028.336882942785, 6035.245594300713, 6044.788432404845, 6047.909281360783, 5730.455606717355, 5749.511291540099, 5754.338251101177, 5807.767689292381, 5844.327902291291, 6021.0, 6024.939750602438, 6026.819195424145, 6031.09533569968, 6046.848828779316, 5483.588730845123, 5604.075327570905, 5660.377358490645, 5725.942740572707, 5734.655920644775, 5619.578531610227, 5645.125005624135, 5691.857703557444, 5711.600187986967, 5848.4151584841175, 5606.635568688022, 5614.52276556481, 5639.7180140993605, 5648.378678345297, 5667.1782591524825, 5640.802571909963, 5650.23721797552, 5655.915161272666, 5657.12314591239, 5659.717014149359, 5486.862828429321, 5515.503604675599, 5622.6345287557815, 5630.465105814941, 5654.575906807088, 5742.942570574241, 5744.712764361849, 5751.971240143773, 5757.107648314518, 5776.844631073718, 5425.891482170414, 5577.609567330248, 5582.637128586629, 5623.044082506066, 5647.124695672177], "value": 5314.30340382333, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [548.3803302268436, 596.4333882811329, 622.5299898576573, 627.6422439209653, 651.4267444648708, 37175.44236836449, 40346.59653403465, 40371.192576148496, 47883.52116478834, 48571.271430928566, 51399.0, 51956.0, 51994.480055199434, 52004.739976300065, 52013.479865201334, 9225.72322830316, 9407.247420206368, 9411.576479058425, 9411.858822117674, 9414.52927353633, 8731.0, 8904.465732056098, 11155.274907131052, 11401.942990285079, 11416.0, 11393.48729307179, 11438.084953203725, 11462.598809041685, 11465.484053217584, 11465.484053217626, 11479.196456248066, 11548.133889958202, 11551.768964620745, 11556.479958401893, 11560.884391156107, 11422.428878556122, 11454.370009649467, 11476.0, 11489.253198542068, 11509.079273658088, 45773.084538309384, 46015.0, 46051.0, 46087.769561152316, 46125.30812037822, 4134.751914885116, 4181.895452613709, 4205.053862880858, 4230.809613567397, 4268.423762792015, 35337.469937950955, 36091.45862812034, 36186.0, 36270.45594316087, 36290.27419451623, 4558.77206139695, 4593.035462552868, 4604.907901841944, 4630.536946305376, 4693.06138772247, 351594.0, 351836.0, 352263.0, 352800.0, 352882.0, 71459.0, 71575.2842471579, 71675.0, 71753.2824671757, 71765.64117179485, 75489.622551888, 75580.0, 75644.0, 75948.0, 76193.61903190559, 19826.90086549558, 20400.795992040188, 20414.69377959332, 20429.387118386472, 20453.0, 13324.73350532984, 13618.86381136176, 14964.551063468114, 14982.0, 14988.700225995419, 18756.24975001012, 19781.307654232034, 20314.28899988493, 20378.592428151354, 21330.466738331357, 6317.4946004319545, 6514.315996820361, 6536.901946470807, 6575.704093315812, 6638.4357329626555, 977.5307852230969, 984.5274268351232, 988.6737376665683, 990.4948476277151, 1007.7178390050798, 34244.486332705026, 34343.31313373719, 34463.0, 34560.48159277613, 34813.82593087018, 1107.7839821234782, 1180.9586664466874, 1186.4483015397882, 1224.6570960131178, 1234.4136535145913, 18139.54651133732, 18223.45329640113, 18315.0, 18322.267109315744, 18447.446576602724, 488020.0, 491965.0, 492281.0, 492853.0, 493214.0, 70089.64955175192, 70093.0, 70157.0, 70192.64903675449, 70206.297937021, 1285.3958639439636, 1490.9776353354707, 1510.8715759160596, 1572.4339237874356, 1580.5969477783322, 30587.694123058485, 34683.65316346804, 35027.47458788069, 35049.8247508771, 35444.0, 58387.0, 59322.11016834837, 59518.0, 59629.40370596412, 59670.0, 385891.0, 386502.0, 386657.0, 386706.0, 387631.0, 28065.579016314365, 38684.41973370346, 42576.36135457909, 44469.55530444784, 45765.77117114393, 43377.783111085504, 43769.562304377825, 48101.27848082212, 48342.27486587634, 48485.27272090992, 39511.60488395079, 39669.404958925064, 40027.3995890056, 40357.596424035386, 41585.792071039454, 39065.02337441587, 39746.40380394354, 40649.79675101605, 41151.0, 41273.1745365097, 39417.0, 39978.2004359917, 40125.19749604933, 40771.184576307714, 40937.0, 33650.83174584111, 35404.11489712778, 35852.64147358493, 36076.45885311775, 36220.4566931491, 26826.329341766614, 27188.1843544694, 27263.86368068147, 27298.181054568395, 27402.17793466199], "value": 21839.61635316791, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [444.69316171841405, 449.7863514830456, 451.55521811016143, 453.1186841593102, 468.39810843066664, 19951.401457956268, 21562.353129406125, 21874.89062554687, 22024.559508809813, 22222.1111155554, 20714.378568642926, 21309.147634094617, 21532.138714451405, 21854.672179917274, 22925.312240632767, 5489.313835770528, 5590.748416321255, 5590.797978434635, 5668.319801623811, 5691.146328050784, 6068.6662233577135, 6084.300305464862, 6120.173776540177, 6123.938760612381, 6129.601575897553, 5493.066178749602, 5527.2538207341895, 5874.177615133864, 6089.969550152266, 6114.2357205349335, 5497.065498865202, 5524.281843360378, 5530.751116199761, 5531.225628412026, 5531.612787104904, 5273.288106105665, 5409.7295135243085, 5439.374471935738, 5498.80754173602, 5505.449455054462, 15352.771778257713, 15410.383584656713, 15440.150791706452, 15462.845371546253, 15484.0, 3019.728224459809, 3169.429502689515, 3175.2061984503875, 3199.520071989197, 3238.5466034755154, 11191.66425007251, 11300.491477883515, 11315.15136364776, 13938.58184254474, 14470.49353272641, 1983.930562430308, 2005.7492813398326, 2058.7735349111585, 2185.311626837557, 2196.791304826039, 82040.0, 92452.0, 94469.0, 94650.0, 96946.51526742321, 12176.81734773979, 12394.442250098768, 12492.375381230902, 12591.559295424617, 12691.555795547112, 18020.549486262687, 18065.367712130013, 18068.36760713395, 18075.09624518795, 18092.095395230448, 8847.601857916408, 8873.955630221808, 8993.685221017233, 9070.27437804974, 9119.0, 8347.707830225912, 8354.874676879852, 8368.24685778283, 8588.441751286146, 8606.827863442697, 5328.227407026037, 5473.0969390051, 5481.780728770885, 5483.287172667528, 5589.077802162679, 2160.735969457885, 2166.5450255446217, 2182.4434769134086, 2189.6715492676226, 2205.746339170984, 919.3840127114715, 935.209747763139, 935.4340623922429, 942.853857652065, 947.0434860790651, 19807.32601098862, 21362.14551417957, 21365.0, 21487.78512214858, 21538.89230553837, 948.2035090523993, 1027.275770581738, 1073.9248252622242, 1092.6012005617893, 1110.9166812488934, 10973.177011724152, 11511.136664750176, 11523.596674116367, 11532.423378831025, 11568.537258509734, 694578.0, 696917.0, 701520.0, 728366.0, 731653.0, 86294.0, 104058.0, 111183.44408277907, 111251.44374278077, 113710.0, 1100.9724756881142, 1122.253701288634, 1131.0951239008925, 1134.8581427321585, 1146.5643055638805, 17359.56601084983, 17628.383006594708, 17670.381536646157, 17706.114694265492, 17974.2810287587, 45835.31247031364, 45865.770671146434, 46156.07687846291, 46250.7687461574, 46855.29717054179, 64717.0, 64928.0, 65347.0, 66116.33883661102, 66469.66765166144, 8559.95720021396, 8627.568621568771, 8821.955890220508, 9074.500902450429, 9246.861297080415, 12884.291363974697, 13809.102408343426, 14083.0, 14239.359228834934, 14453.566393008226, 11377.317360958368, 11770.82343764827, 11810.055195584504, 12254.754904901674, 12805.103642744918, 11491.482883270106, 12273.140880138304, 12388.0, 12684.429200685807, 13045.934770326088, 12190.146689731988, 12191.390430478617, 12435.75128497443, 12503.499860005499, 12693.555725549562, 8783.736487905373, 8821.073787252502, 9027.45835249887, 9387.10822471864, 9888.357256778287, 12075.154739168174, 12117.27296362221, 12206.87793122093, 12470.438830252479, 12565.874341256836], "value": 9947.3394311953, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1405.7329107469586, 1509.9471518496848, 1511.5616471223345, 1528.8853335999802, 1533.2257210108894, 7869.724559640406, 8312.750617481477, 8525.829483410329, 8538.27424668904, 8676.956615216915, 8487.660493580264, 8554.059053504125, 8565.100664430238, 8565.271951884097, 8566.785830354243, 2010.0954570443287, 2080.0, 2440.2679196241147, 2473.418746594549, 2477.900883964648, 2419.2621250518587, 2519.6346529753173, 2527.5576774064557, 2545.083769842855, 2546.936326591841, 2461.1509029384924, 2467.346153269385, 2484.3416494628937, 2490.489449662815, 2506.3608779761134, 2470.7405722399158, 2484.428581426273, 2498.2380373985925, 2517.5720127578356, 2518.294877434312, 2396.269137912936, 2423.4426082001237, 2484.24230609664, 2488.912888048928, 2489.775920167194, 8881.822363552692, 8937.50843703596, 8998.505082220476, 9015.36892417531, 9033.367664263438, 5475.288212532345, 5605.822777216789, 5614.887702245973, 5623.8594035149035, 5631.042722737145, 3430.142464383904, 3479.739019573542, 3508.438649816043, 3509.052555809917, 3546.716262698978, 1382.1637909065073, 1414.6887684709347, 1425.0879437160227, 1432.5773896700393, 1499.2967370594613, 12204.511819527208, 12313.876861231363, 12347.444365003596, 12422.937885310606, 12434.378281086, 4769.427668679711, 4880.511948805091, 4886.096072226649, 4962.454130045692, 5014.548690617789, 9787.36382135159, 9798.951005245071, 9806.509674516246, 9815.75460613476, 9835.213182945346, 5501.889962200734, 5547.195656629766, 5559.360673522516, 5564.610477266633, 5566.165075238666, 4201.768902710319, 4873.975630121827, 4940.2342636891335, 5005.549500544968, 5094.872628184251, 4142.150859073882, 4212.3681447782465, 4266.466691663542, 4301.0537681709975, 4302.397664326997, 1344.8117263583106, 1365.208179256029, 1371.9657008574666, 1380.2339701465582, 1389.0693235532217, 949.6248981652209, 955.5986485675894, 957.368137029571, 959.7360725800461, 981.0, 5719.914201286984, 5724.79963201286, 5780.913286300709, 5797.304323481125, 5826.783367632788, 629.5530173576811, 631.6620607974803, 636.9299377068519, 643.2088531106672, 649.1820306413953, 3534.840932158059, 3564.269324788412, 3596.9100772480897, 3643.4899114124046, 3659.3779057560278, 9943.403395796275, 10236.53935572901, 10266.6406675766, 10267.691969240936, 10292.228082893664, 10046.296759226783, 10117.392956422638, 10131.493425328705, 10204.489775511343, 10213.285070045025, 8106.675732970615, 8238.258556730043, 8241.587920603946, 8263.421560490708, 8272.0, 5385.973070134781, 5386.649867758583, 5386.784528618811, 5438.021156191923, 5462.262594549844, 9318.161365477139, 9334.766630834283, 9340.766480838034, 9346.299027572823, 9455.14903658674, 9431.905680943102, 9523.666671666459, 9523.952380238054, 9624.903750962681, 9630.711078667651, 6472.061551074974, 6690.69891854858, 6692.464602831859, 7432.851342973002, 7514.549127052394, 7101.751438699827, 8096.87854682192, 8142.10436851934, 8344.249017588447, 8351.95824020876, 7173.928260717326, 7263.0921134858145, 7302.233265507258, 7340.0, 7377.557346559223, 7184.389326907271, 7212.8918066228, 7272.490925635367, 7281.453890958093, 7304.123505179413, 6369.840753981188, 6451.41937225652, 6470.902936455863, 6473.061406096184, 6479.708413121327, 5049.0, 5063.746812659426, 5083.262926875656, 5109.463506331782, 5267.183586544092, 4812.735299558558, 4883.926741098958, 4923.753812309442, 4943.233798761198, 4998.375203099613], "value": 4564.74956023824, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [411.5041375142953, 416.0576294692522, 419.870548225274, 427.97004209705335, 432.87879393769737, 5293.0, 5315.123004704224, 5317.218731724877, 5337.638902079969, 5345.224942383357, 5098.566621837139, 5128.7948482060765, 5256.211568264762, 5283.313169287997, 5320.0, 4243.305501006867, 4249.150169966019, 4255.510616279121, 4272.124214536028, 4273.316269396897, 4282.486101667789, 4284.371938663304, 4292.935605965913, 4299.935500967488, 4310.612044915957, 3960.5049368828895, 4119.054875763828, 4120.732152410099, 4147.5645057269, 4261.850835220768, 4146.1914926589325, 4147.668186545099, 4147.71420859533, 4149.365153127756, 4152.37714342848, 3694.9815250923843, 3726.608706085849, 3732.720045996534, 3734.458503517002, 3760.811959402019, 4962.702237865704, 5236.345456817898, 5244.8688782780355, 5256.132738098209, 5273.683578985273, 4824.5899098576665, 4828.686135401223, 4851.781669824831, 4855.198892182786, 4864.756762161913, 5598.832035038955, 5606.411326810667, 5641.943580564224, 5645.221755147116, 5645.7579332546775, 4063.7155399122075, 4086.6730661547003, 4127.47283505102, 4135.841964250015, 4141.109661422808, 5488.862778430531, 5597.468240517103, 5730.627509211888, 5748.0, 5784.68184249866, 4057.594240575978, 4138.193052354762, 4157.729747566398, 4177.8537751178565, 4190.559991200941, 4250.128723611652, 4269.530351661315, 4273.786310684453, 4276.2089013532595, 4286.678499112517, 4615.3999980003055, 4651.976740116278, 4734.526547345238, 4752.619790416758, 4765.380500534978, 5555.972220138873, 5561.916571251434, 5570.910908409346, 5586.385497595261, 5588.608797384144, 1401.1242973141786, 1411.1495669998928, 1412.0398129272194, 1416.9008169428248, 1428.6214153249398, 954.6849539651898, 978.7259567321162, 987.2003677021636, 987.511181964932, 992.4839083676592, 5213.661112027706, 5215.869603259949, 5246.737663116829, 5266.315379000705, 5270.683758974474, 5409.26974858397, 5449.945500545023, 5453.400125986138, 5461.644993075517, 5489.231507588941, 5201.765920533585, 5348.5186333230195, 5523.861903452445, 5563.666180029211, 5573.972130139324, 2944.102048875071, 2948.9852550737537, 2954.3943491584173, 2956.6051498286456, 2958.2604348912773, 5488.0, 5728.79949201776, 5763.510101641407, 5772.307323121168, 5822.883542329129, 5551.944480555143, 5624.943750562442, 5672.517835983987, 5693.202951586781, 5703.572232082611, 5664.660120392789, 5811.0, 5831.475167234969, 5834.504067154339, 5844.59087863854, 5270.420253772006, 5447.972760136174, 5448.536874365724, 5461.672299662033, 5536.889262214814, 5371.758270877742, 5405.567554595545, 5437.374701909331, 5481.342238931354, 5523.4200408956485, 5800.738966746591, 5942.227510423791, 5970.164177015308, 6027.427394397525, 6033.758649653964, 4179.6029377209115, 4208.894777630584, 4217.95782042188, 4233.132207897312, 4240.703150779415, 5587.804426845041, 5679.318481782213, 5700.372958974593, 5711.771529138788, 5713.685747283939, 5490.533304669148, 5496.203050557567, 5504.834854954358, 5528.778848846162, 5560.944390556043, 5402.58085706741, 5488.286522752017, 5542.972285138549, 5570.693611851387, 5590.413006634245, 5436.891262174813, 5452.6640972960295, 5465.535429488538, 5489.972550137224, 5518.365387980273, 5500.669959802424, 5513.61404701667, 5550.306211723535, 5555.527780138734, 5577.928112477995, 5157.277981082577, 5376.301080859464, 5443.210734443563, 5445.564354851682, 5501.4223506532835], "value": 4276.458814572231, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [716.6631683108939, 741.7997140771992, 747.8279995601011, 786.1548835002374, 796.7649543384701, 15683.529494115195, 15742.134182619966, 15776.921115394407, 15909.045457272558, 16223.513294601165, 13806.585802425918, 13896.791548126786, 13933.094348867342, 15740.976836505619, 15912.965657232271, 813.8046868751502, 828.5857071464268, 831.2477208126655, 831.4304701279613, 832.1678321678322, 697.6302559643372, 720.9315115064061, 817.513579420244, 833.5707110837923, 839.2782207301716, 884.1026358246353, 885.2165833237567, 885.8272636835819, 886.0873300500494, 886.1448702002566, 877.5919197573127, 878.0253918150847, 878.2666473494639, 879.1252703559935, 879.53824242273, 648.2609824799732, 649.7888186339459, 649.9610023398563, 649.9870002599969, 650.1288273713247, 16049.91975040129, 16163.676726465404, 16270.26783794732, 16870.746938795804, 17035.0, 15633.296501657453, 15836.0, 15846.0, 15958.920205399016, 16150.434734784227, 12810.55163069288, 12904.096713230078, 12921.28932908699, 12967.286799226038, 12971.67570810728, 3962.6235507627016, 3994.940075898864, 3998.280309544281, 4077.8572749953905, 4079.714419990602, 80484.59757701174, 81648.59175704143, 81909.0, 82552.0, 84477.57761211216, 11733.4719937603, 11740.647780566596, 11745.17783755146, 11767.176297659253, 11905.940470297766, 21619.0, 21665.45836354072, 21706.78293217079, 21839.344819655435, 21897.12411503522, 8244.692720808076, 8387.83224335522, 8425.536595487307, 8464.238218560358, 8562.61468233931, 4514.6388288936805, 4564.7717614119165, 4577.931331030038, 4621.260598304255, 4640.883977900579, 3796.6393192646656, 3874.7675139491157, 3912.7456715313415, 3914.980425097913, 3919.0790164311366, 646.9159009328852, 647.3688154049764, 650.2716957008087, 650.4146268358515, 664.3920812456645, 727.9490435669452, 737.2774680812834, 753.3408267765705, 755.4578842195971, 756.1380619143628, 10153.593856245816, 10357.0, 10412.219083568763, 10422.739431514272, 10452.268341216042, 589.2016317889284, 591.9852003699942, 598.628850112924, 601.2034054877305, 608.8477880529867, 4863.586595139382, 4941.0, 4974.950250497449, 4979.352684151109, 4991.376077990251, 67301.3269867295, 73631.63184184044, 74847.25152748512, 87012.56493717617, 90120.0, 58922.0, 74762.25237747662, 75628.24371756212, 76530.0, 79792.0, 66721.66639166774, 66787.66606166938, 67437.3256267431, 67687.0, 69973.65013175004, 10471.528781205016, 10669.41318227505, 10762.246642734934, 11188.83216751733, 11315.603953861575, 45382.09235815199, 46443.303350449096, 46470.767646161556, 46516.7674161627, 47783.52216477791, 55843.441565583824, 58194.4180558189, 58848.0, 59436.40563594309, 59916.700416499385, 12520.0, 12703.174293670882, 12795.80806287925, 12996.610101696964, 13033.283169425773, 13861.584152475441, 13927.57103840117, 14081.366338514586, 14099.224542650252, 14100.435982560582, 13056.432781878679, 13304.667383315107, 13650.26994601064, 14046.578602641937, 14114.647133821736, 12130.090243231616, 12201.145919785884, 12397.132200745862, 12564.811527827273, 13272.32719779271, 13299.135556188818, 13475.932620336836, 13646.0, 13742.450301988209, 13842.4463021478, 10800.567977281135, 10940.288881222696, 11224.494897729459, 11472.598459054227, 11659.0, 9989.60041598328, 10606.469676516297, 10840.837387439036, 10854.891451085388, 11033.503492343025], "value": 7417.695250843979, "unit": "score"}], "name": "dromaeo_css", "value": 7422.262753012483, "alertThreshold": 5.0}, {"lowerIsBetter": true, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [102.0, 112.0, 110.0, 112.0, 114.0, 113.0, 111.0, 113.0, 110.0, 113.0], "value": 111.0, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [138.0, 116.0, 122.0, 155.0, 116.0, 117.0, 116.0, 115.0, 132.0, 116.0], "value": 124.3, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [159.0, 160.0, 160.0, 163.0, 159.0, 160.0, 161.0, 160.0, 159.0, 159.0], "value": 160.0, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [75.0, 75.0, 76.0, 113.0, 76.0, 74.0, 75.0, 75.0, 99.0, 76.0], "value": 81.4, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [82.0, 82.0, 111.0, 83.0, 83.0, 82.0, 93.0, 83.0, 82.0, 97.0], "value": 87.8, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [117.0, 117.0, 116.0, 117.0, 116.0, 117.0, 116.0, 116.0, 116.0, 116.0], "value": 116.4, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [146.0, 146.0, 147.0, 146.0, 147.0, 146.0, 146.0, 147.0, 146.0, 146.0], "value": 146.3, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [95.0, 97.0, 95.0, 96.0, 96.0, 95.0, 95.0, 96.0, 96.0, 95.0], "value": 95.6, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [53.0, 62.0, 51.0, 52.0, 52.0, 53.0, 53.0, 57.0, 51.0, 51.0], "value": 53.5, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [63.0, 63.0, 61.0, 62.0, 64.0, 66.0, 62.0, 64.0, 62.0, 63.0], "value": 63.0, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [74.0, 73.0, 82.0, 75.0, 74.0, 85.0, 76.0, 83.0, 75.0, 77.0], "value": 77.4, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [123.0, 120.0, 126.0, 125.0, 119.0, 127.0, 118.0, 119.0, 163.0, 117.0], "value": 125.7, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [155.0, 156.0, 155.0, 154.0, 155.0, 158.0, 156.0, 157.0, 153.0, 158.0], "value": 155.7, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [61.0, 64.0, 62.0, 61.0, 62.0, 59.0, 59.0, 60.0, 59.0, 60.0], "value": 60.7, "unit": "score"}], "name": "kraken", "value": 1458.8000000000004, "alertThreshold": 2.0}]} 09:53:56 INFO - Return code: 0 09:53:56 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 09:53:56 INFO - # TBPL SUCCESS # 09:53:56 INFO - Running post-action listener: _resource_record_post_action 09:53:56 INFO - [mozharness: 2017-03-14 16:53:56.349777Z] Finished run-tests step (success) 09:53:56 INFO - Running post-run listener: _resource_record_post_run 09:53:56 INFO - Total resource usage - Wall time: 1187s; CPU: 13.0%; Read bytes: 4096; Write bytes: 324972544; Read time: 8; Write time: 186612 09:53:56 INFO - TinderboxPrint: CPU usage
13.0% 09:53:56 INFO - TinderboxPrint: I/O read bytes / time
4,096 / 8 09:53:56 INFO - TinderboxPrint: I/O write bytes / time
324,972,544 / 186,612 09:53:56 INFO - TinderboxPrint: CPU idle
8,245.0 (87.0%) 09:53:56 INFO - TinderboxPrint: CPU user
1,187.0 (12.5%) 09:53:56 INFO - TinderboxPrint: Swap in / out
0 / 0 09:53:56 INFO - install - Wall time: 14s; CPU: 13.0%; Read bytes: 0; Write bytes: 102359040; Read time: 0; Write time: 93040 09:53:56 INFO - run-tests - Wall time: 1173s; CPU: 13.0%; Read bytes: 0; Write bytes: 222265344; Read time: 0; Write time: 93568 09:53:56 INFO - Running post-run listener: _upload_blobber_files 09:53:56 INFO - Blob upload gear active. 09:53:56 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 09:53:56 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 09:53:56 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', 'Mozilla-Beta', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 09:53:56 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 Mozilla-Beta -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 09:53:57 INFO - (blobuploader) - INFO - Open directory for files ... 09:53:57 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log ... 09:53:57 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 09:53:57 INFO - (blobuploader) - INFO - Uploading, attempt #1. 09:53:58 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded 09:53:58 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 09:53:58 INFO - (blobuploader) - INFO - Done attempting. 09:53:58 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/perfherder-data.json ... 09:53:58 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 09:53:58 INFO - (blobuploader) - INFO - Uploading, attempt #1. 09:53:59 INFO - (blobuploader) - INFO - TinderboxPrint: perfherder-data.json: uploaded 09:53:59 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 09:53:59 INFO - (blobuploader) - INFO - Done attempting. 09:53:59 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 09:53:59 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 09:53:59 INFO - (blobuploader) - INFO - Uploading, attempt #1. 09:54:03 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 09:54:03 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 09:54:03 INFO - (blobuploader) - INFO - Done attempting. 09:54:03 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log ... 09:54:03 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 09:54:03 INFO - (blobuploader) - INFO - Uploading, attempt #1. 09:54:04 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded 09:54:04 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 09:54:04 INFO - (blobuploader) - INFO - Done attempting. 09:54:04 INFO - (blobuploader) - INFO - Iteration through files over. 09:54:04 INFO - Return code: 0 09:54:04 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 09:54:04 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 09:54:04 INFO - Setting buildbot property blobber_files to {"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/9bbdaeb0154d0b44d24069092ee4e67f790d7ebd10f0b3f935593615972d8999dc1c6739b6b4b68291b7b4fbd81fdb7d97a4fa60a3c8ddc0db1077fdc09f1547", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/a843528a40d8e5f5539b7560daedf9b8c48118a4d6f60e2f5dfb91cc0d97a0644cc3cedc66ba439a882d465ac3e8c3c46a65fd24d0a85ba0533b470ffc666755", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/8e29ee1a53ecfc131e7af80e807d6f6e9ef34baee781929e0032ab54bf0e5ff9db6c7ef4fe46a0a981feaa4d12ad39aa5f7ef7796992025e57d6320674720944", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/e6649c8d02a05f2b932d0208320528432d0bf071c21d6134c860f1f4a4f432c2afdf2575aafed5ca02418872d63848f717fc658d39a06f622fec6d011cf730c6"} 09:54:04 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 09:54:04 INFO - Writing to file /builds/slave/test/properties/blobber_files 09:54:04 INFO - Contents: 09:54:04 INFO - blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/9bbdaeb0154d0b44d24069092ee4e67f790d7ebd10f0b3f935593615972d8999dc1c6739b6b4b68291b7b4fbd81fdb7d97a4fa60a3c8ddc0db1077fdc09f1547", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/a843528a40d8e5f5539b7560daedf9b8c48118a4d6f60e2f5dfb91cc0d97a0644cc3cedc66ba439a882d465ac3e8c3c46a65fd24d0a85ba0533b470ffc666755", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/8e29ee1a53ecfc131e7af80e807d6f6e9ef34baee781929e0032ab54bf0e5ff9db6c7ef4fe46a0a981feaa4d12ad39aa5f7ef7796992025e57d6320674720944", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/e6649c8d02a05f2b932d0208320528432d0bf071c21d6134c860f1f4a4f432c2afdf2575aafed5ca02418872d63848f717fc658d39a06f622fec6d011cf730c6"} 09:54:04 INFO - Running post-run listener: copy_logs_to_upload_dir 09:54:04 INFO - Copying logs to upload dir... 09:54:04 INFO - mkdir: /builds/slave/test/build/upload/logs 09:54:04 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1234.273489 ========= master_lag: 0.04 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 34 secs) (at 2017-03-14 09:54:04.845467) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-03-14 09:54:04.854480) ========= 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=ca619d3d7d62c99d832f7b8a000001c4-1489509208.45274-2124180520 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/9bbdaeb0154d0b44d24069092ee4e67f790d7ebd10f0b3f935593615972d8999dc1c6739b6b4b68291b7b4fbd81fdb7d97a4fa60a3c8ddc0db1077fdc09f1547", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/a843528a40d8e5f5539b7560daedf9b8c48118a4d6f60e2f5dfb91cc0d97a0644cc3cedc66ba439a882d465ac3e8c3c46a65fd24d0a85ba0533b470ffc666755", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/8e29ee1a53ecfc131e7af80e807d6f6e9ef34baee781929e0032ab54bf0e5ff9db6c7ef4fe46a0a981feaa4d12ad39aa5f7ef7796992025e57d6320674720944", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/e6649c8d02a05f2b932d0208320528432d0bf071c21d6134c860f1f4a4f432c2afdf2575aafed5ca02418872d63848f717fc658d39a06f622fec6d011cf730c6"} build_url:https://queue.taskcluster.net/v1/task/SWlXTsUfQ3eVHfbMtpvdEg/artifacts/public/build/target.tar.bz2 program finished with exit code 0 elapsedTime=0.011269 build_url: 'https://queue.taskcluster.net/v1/task/SWlXTsUfQ3eVHfbMtpvdEg/artifacts/public/build/target.tar.bz2' blobber_files: '{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/9bbdaeb0154d0b44d24069092ee4e67f790d7ebd10f0b3f935593615972d8999dc1c6739b6b4b68291b7b4fbd81fdb7d97a4fa60a3c8ddc0db1077fdc09f1547", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/a843528a40d8e5f5539b7560daedf9b8c48118a4d6f60e2f5dfb91cc0d97a0644cc3cedc66ba439a882d465ac3e8c3c46a65fd24d0a85ba0533b470ffc666755", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/8e29ee1a53ecfc131e7af80e807d6f6e9ef34baee781929e0032ab54bf0e5ff9db6c7ef4fe46a0a981feaa4d12ad39aa5f7ef7796992025e57d6320674720944", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/e6649c8d02a05f2b932d0208320528432d0bf071c21d6134c860f1f4a4f432c2afdf2575aafed5ca02418872d63848f717fc658d39a06f622fec6d011cf730c6"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-03-14 09:54:04.879222) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-03-14 09:54:04.879551) ========= 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=ca619d3d7d62c99d832f7b8a000001c4-1489509208.45274-2124180520 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004510 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-03-14 09:54:04.964738) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2017-03-14 09:54:04.967101) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2017-03-14 09:54:04.967437) ========= ========= Total master_lag: 0.20 =========